0s autopkgtest [18:36:08]: starting date and time: 2025-07-08 18:36:08+0000
0s autopkgtest [18:36:08]: git checkout: 508d4a25 a-v-ssh wait_for_ssh: demote "ssh connection failed" to a debug message
0s autopkgtest [18:36:08]: host juju-7f2275-prod-proposed-migration-environment-2; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.fj6x3moi/out --timeout-copy=6000 --setup-commands /home/ubuntu/autopkgtest-cloud/worker-config-production/setup-canonical.sh --apt-pocket=proposed=src:podman --apt-upgrade cockpit-podman --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 --env=ADT_TEST_TRIGGERS=podman/5.4.2+ds1-2 -- ssh -s /home/ubuntu/autopkgtest/ssh-setup/nova -- --flavor autopkgtest-ppc64el --security-groups autopkgtest-juju-7f2275-prod-proposed-migration-environment-2@bos03-ppc64el-20.secgroup --name adt-questing-ppc64el-cockpit-podman-20250708-183607-juju-7f2275-prod-proposed-migration-environment-2-8b35baae-1492-4e96-b407-a11d4772b3bf --image adt/ubuntu-questing-ppc64el-server --keyname testbed-juju-7f2275-prod-proposed-migration-environment-2 --net-id=net_prod-proposed-migration-ppc64el -e TERM=linux --mirror=http://ftpmaster.internal/ubuntu/
4s Creating nova instance adt-questing-ppc64el-cockpit-podman-20250708-183607-juju-7f2275-prod-proposed-migration-environment-2-8b35baae-1492-4e96-b407-a11d4772b3bf from image adt/ubuntu-questing-ppc64el-server-20250708.img (UUID c8580573-1fd9-4c37-84e4-b8638c6115c3)...
55s autopkgtest [18:37:03]: testbed dpkg architecture: ppc64el
56s autopkgtest [18:37:04]: testbed apt version: 3.1.3
56s autopkgtest [18:37:04]: @@@@@@@@@@@@@@@@@@@@ test bed setup
56s autopkgtest [18:37:04]: testbed release detected to be: None
57s autopkgtest [18:37:05]: updating testbed package index (apt update)
57s Get:1 http://ftpmaster.internal/ubuntu questing-proposed InRelease [249 kB]
58s Hit:2 http://ftpmaster.internal/ubuntu questing InRelease
58s Hit:3 http://ftpmaster.internal/ubuntu questing-updates InRelease
58s Hit:4 http://ftpmaster.internal/ubuntu questing-security InRelease
58s Get:5 http://ftpmaster.internal/ubuntu questing-proposed/main Sources [29.6 kB]
58s Get:6 http://ftpmaster.internal/ubuntu questing-proposed/universe Sources [180 kB]
58s Get:7 http://ftpmaster.internal/ubuntu questing-proposed/multiverse Sources [15.4 kB]
58s Get:8 http://ftpmaster.internal/ubuntu questing-proposed/main ppc64el Packages [51.3 kB]
58s Get:9 http://ftpmaster.internal/ubuntu questing-proposed/universe ppc64el Packages [152 kB]
58s Get:10 http://ftpmaster.internal/ubuntu questing-proposed/multiverse ppc64el Packages [4452 B]
58s Fetched 682 kB in 1s (822 kB/s)
59s Reading package lists...
59s autopkgtest [18:37:07]: upgrading testbed (apt dist-upgrade and autopurge)
60s Reading package lists...
60s Building dependency tree...
60s Reading state information...
60s Calculating upgrade...
60s The following NEW packages will be installed:
60s linux-headers-6.15.0-4 linux-headers-6.15.0-4-generic
60s linux-image-6.15.0-4-generic linux-modules-6.15.0-4-generic
60s The following packages will be upgraded:
60s bpftool linux-generic linux-headers-generic linux-headers-virtual
60s linux-image-generic linux-image-virtual linux-libc-dev linux-perf
60s linux-tools-common linux-virtual
60s 10 upgraded, 4 newly installed, 0 to remove and 0 not upgraded.
60s Need to get 230 MB of archives.
60s After this operation, 322 MB of additional disk space will be used.
60s Get:1 http://ftpmaster.internal/ubuntu questing/main ppc64el bpftool ppc64el 7.6.0+6.15.0-4.4 [1223 kB]
61s Get:2 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-modules-6.15.0-4-generic ppc64el 6.15.0-4.4 [141 MB]
65s Get:3 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-image-6.15.0-4-generic ppc64el 6.15.0-4.4 [64.2 MB]
67s Get:4 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-generic ppc64el 6.15.0-4.4 [1734 B]
67s Get:5 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-image-generic ppc64el 6.15.0-4.4 [11.4 kB]
67s Get:6 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-virtual ppc64el 6.15.0-4.4 [1728 B]
67s Get:7 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-image-virtual ppc64el 6.15.0-4.4 [11.4 kB]
67s Get:8 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-headers-virtual ppc64el 6.15.0-4.4 [1644 B]
67s Get:9 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-headers-6.15.0-4 all 6.15.0-4.4 [14.4 MB]
68s Get:10 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-headers-6.15.0-4-generic ppc64el 6.15.0-4.4 [4216 kB]
68s Get:11 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-headers-generic ppc64el 6.15.0-4.4 [11.3 kB]
68s Get:12 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-libc-dev ppc64el 6.15.0-4.4 [1763 kB]
68s Get:13 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-perf ppc64el 6.15.0-4.4 [2655 kB]
68s Get:14 http://ftpmaster.internal/ubuntu questing/main ppc64el linux-tools-common all 6.15.0-4.4 [337 kB]
68s Fetched 230 MB in 8s (28.6 MB/s)
69s (Reading database ...
(Reading database ... 5%
(Reading database ... 10%
(Reading database ... 15%
(Reading database ... 20%
(Reading database ... 25%
(Reading database ... 30%
(Reading database ... 35%
(Reading database ... 40%
(Reading database ... 45%
(Reading database ... 50%
(Reading database ... 55%
(Reading database ... 60%
(Reading database ... 65%
(Reading database ... 70%
(Reading database ... 75%
(Reading database ... 80%
(Reading database ... 85%
(Reading database ... 90%
(Reading database ... 95%
(Reading database ... 100%
(Reading database ... 114389 files and directories currently installed.)
69s Preparing to unpack .../00-bpftool_7.6.0+6.15.0-4.4_ppc64el.deb ...
69s Unpacking bpftool (7.6.0+6.15.0-4.4) over (7.6.0+6.15.0-3.3) ...
69s Selecting previously unselected package linux-modules-6.15.0-4-generic.
69s Preparing to unpack .../01-linux-modules-6.15.0-4-generic_6.15.0-4.4_ppc64el.deb ...
69s Unpacking linux-modules-6.15.0-4-generic (6.15.0-4.4) ...
70s Selecting previously unselected package linux-image-6.15.0-4-generic.
70s Preparing to unpack .../02-linux-image-6.15.0-4-generic_6.15.0-4.4_ppc64el.deb ...
70s Unpacking linux-image-6.15.0-4-generic (6.15.0-4.4) ...
70s Preparing to unpack .../03-linux-generic_6.15.0-4.4_ppc64el.deb ...
70s Unpacking linux-generic (6.15.0-4.4) over (6.15.0-3.3+1) ...
70s Preparing to unpack .../04-linux-image-generic_6.15.0-4.4_ppc64el.deb ...
70s Unpacking linux-image-generic (6.15.0-4.4) over (6.15.0-3.3+1) ...
70s Preparing to unpack .../05-linux-virtual_6.15.0-4.4_ppc64el.deb ...
70s Unpacking linux-virtual (6.15.0-4.4) over (6.15.0-3.3+1) ...
70s Preparing to unpack .../06-linux-image-virtual_6.15.0-4.4_ppc64el.deb ...
70s Unpacking linux-image-virtual (6.15.0-4.4) over (6.15.0-3.3+1) ...
70s Preparing to unpack .../07-linux-headers-virtual_6.15.0-4.4_ppc64el.deb ...
70s Unpacking linux-headers-virtual (6.15.0-4.4) over (6.15.0-3.3+1) ...
70s Selecting previously unselected package linux-headers-6.15.0-4.
70s Preparing to unpack .../08-linux-headers-6.15.0-4_6.15.0-4.4_all.deb ...
70s Unpacking linux-headers-6.15.0-4 (6.15.0-4.4) ...
72s Selecting previously unselected package linux-headers-6.15.0-4-generic.
72s Preparing to unpack .../09-linux-headers-6.15.0-4-generic_6.15.0-4.4_ppc64el.deb ...
72s Unpacking linux-headers-6.15.0-4-generic (6.15.0-4.4) ...
73s Preparing to unpack .../10-linux-headers-generic_6.15.0-4.4_ppc64el.deb ...
73s Unpacking linux-headers-generic (6.15.0-4.4) over (6.15.0-3.3+1) ...
73s Preparing to unpack .../11-linux-libc-dev_6.15.0-4.4_ppc64el.deb ...
73s Unpacking linux-libc-dev:ppc64el (6.15.0-4.4) over (6.15.0-3.3) ...
73s Preparing to unpack .../12-linux-perf_6.15.0-4.4_ppc64el.deb ...
73s Unpacking linux-perf (6.15.0-4.4) over (6.15.0-3.3) ...
73s Preparing to unpack .../13-linux-tools-common_6.15.0-4.4_all.deb ...
73s Unpacking linux-tools-common (6.15.0-4.4) over (6.15.0-3.3) ...
73s Setting up bpftool (7.6.0+6.15.0-4.4) ...
73s Setting up linux-headers-6.15.0-4 (6.15.0-4.4) ...
73s Setting up linux-libc-dev:ppc64el (6.15.0-4.4) ...
73s Setting up linux-headers-6.15.0-4-generic (6.15.0-4.4) ...
73s Setting up linux-perf (6.15.0-4.4) ...
73s Setting up linux-modules-6.15.0-4-generic (6.15.0-4.4) ...
75s Setting up linux-tools-common (6.15.0-4.4) ...
75s Setting up linux-headers-generic (6.15.0-4.4) ...
75s Setting up linux-image-6.15.0-4-generic (6.15.0-4.4) ...
77s I: /boot/vmlinux.old is now a symlink to vmlinux-6.15.0-3-generic
77s I: /boot/initrd.img.old is now a symlink to initrd.img-6.15.0-3-generic
77s I: /boot/vmlinux is now a symlink to vmlinux-6.15.0-4-generic
77s I: /boot/initrd.img is now a symlink to initrd.img-6.15.0-4-generic
77s Setting up linux-image-virtual (6.15.0-4.4) ...
77s Setting up linux-image-generic (6.15.0-4.4) ...
77s Setting up linux-headers-virtual (6.15.0-4.4) ...
77s Setting up linux-generic (6.15.0-4.4) ...
77s Setting up linux-virtual (6.15.0-4.4) ...
77s Processing triggers for man-db (2.13.1-1) ...
78s Processing triggers for linux-image-6.15.0-4-generic (6.15.0-4.4) ...
78s /etc/kernel/postinst.d/initramfs-tools:
78s update-initramfs: Generating /boot/initrd.img-6.15.0-4-generic
78s W: No lz4 in /usr/bin:/sbin:/bin, using gzip
86s /etc/kernel/postinst.d/zz-update-grub:
86s Sourcing file `/etc/default/grub'
86s Sourcing file `/etc/default/grub.d/50-cloudimg-settings.cfg'
86s Generating grub configuration file ...
86s Found linux image: /boot/vmlinux-6.15.0-4-generic
86s Found initrd image: /boot/initrd.img-6.15.0-4-generic
86s Found linux image: /boot/vmlinux-6.15.0-3-generic
86s Found initrd image: /boot/initrd.img-6.15.0-3-generic
86s Found linux image: /boot/vmlinux-6.14.0-15-generic
86s Found initrd image: /boot/initrd.img-6.14.0-15-generic
86s Warning: os-prober will not be executed to detect other bootable partitions.
86s Systems on them will not be added to the GRUB boot configuration.
86s Check GRUB_DISABLE_OS_PROBER documentation entry.
86s Adding boot menu entry for UEFI Firmware Settings ...
86s done
87s Reading package lists...
87s Building dependency tree...
87s Reading state information...
87s Solving dependencies...
87s The following packages will be REMOVED:
87s linux-headers-6.14.0-15* linux-headers-6.14.0-15-generic*
87s linux-image-6.14.0-15-generic* linux-modules-6.14.0-15-generic*
87s linux-modules-extra-6.14.0-15-generic* linux-tools-6.14.0-15*
87s linux-tools-6.14.0-15-generic* wireless-regdb*
87s 0 upgraded, 0 newly installed, 8 to remove and 0 not upgraded.
87s After this operation, 325 MB disk space will be freed.
87s (Reading database ...
(Reading database ... 5%
(Reading database ... 10%
(Reading database ... 15%
(Reading database ... 20%
(Reading database ... 25%
(Reading database ... 30%
(Reading database ... 35%
(Reading database ... 40%
(Reading database ... 45%
(Reading database ... 50%
(Reading database ... 55%
(Reading database ... 60%
(Reading database ... 65%
(Reading database ... 70%
(Reading database ... 75%
(Reading database ... 80%
(Reading database ... 85%
(Reading database ... 90%
(Reading database ... 95%
(Reading database ... 100%
(Reading database ... 152528 files and directories currently installed.)
87s Removing linux-headers-6.14.0-15-generic (6.14.0-15.15) ...
88s Removing linux-headers-6.14.0-15 (6.14.0-15.15) ...
90s Removing linux-image-6.14.0-15-generic (6.14.0-15.15) ...
90s /etc/kernel/postrm.d/initramfs-tools:
90s update-initramfs: Deleting /boot/initrd.img-6.14.0-15-generic
90s /etc/kernel/postrm.d/zz-update-grub:
90s Sourcing file `/etc/default/grub'
90s Sourcing file `/etc/default/grub.d/50-cloudimg-settings.cfg'
90s Generating grub configuration file ...
90s Found linux image: /boot/vmlinux-6.15.0-4-generic
90s Found initrd image: /boot/initrd.img-6.15.0-4-generic
90s Found linux image: /boot/vmlinux-6.15.0-3-generic
90s Found initrd image: /boot/initrd.img-6.15.0-3-generic
90s Warning: os-prober will not be executed to detect other bootable partitions.
90s Systems on them will not be added to the GRUB boot configuration.
90s Check GRUB_DISABLE_OS_PROBER documentation entry.
90s Adding boot menu entry for UEFI Firmware Settings ...
90s done
90s Removing linux-modules-extra-6.14.0-15-generic (6.14.0-15.15) ...
92s Removing linux-modules-6.14.0-15-generic (6.14.0-15.15) ...
92s Removing linux-tools-6.14.0-15-generic (6.14.0-15.15) ...
92s Removing linux-tools-6.14.0-15 (6.14.0-15.15) ...
92s Removing wireless-regdb (2024.10.07-0ubuntu2) ...
92s dpkg: warning: while removing wireless-regdb, directory '/lib/firmware' not empty so not removed
92s Processing triggers for man-db (2.13.1-1) ...
92s (Reading database ...
(Reading database ... 5%
(Reading database ... 10%
(Reading database ... 15%
(Reading database ... 20%
(Reading database ... 25%
(Reading database ... 30%
(Reading database ... 35%
(Reading database ... 40%
(Reading database ... 45%
(Reading database ... 50%
(Reading database ... 55%
(Reading database ... 60%
(Reading database ... 65%
(Reading database ... 70%
(Reading database ... 75%
(Reading database ... 80%
(Reading database ... 85%
(Reading database ... 90%
(Reading database ... 95%
(Reading database ... 100%
(Reading database ... 114515 files and directories currently installed.)
92s Purging configuration files for linux-image-6.14.0-15-generic (6.14.0-15.15) ...
92s Purging configuration files for linux-modules-extra-6.14.0-15-generic (6.14.0-15.15) ...
92s Purging configuration files for linux-modules-6.14.0-15-generic (6.14.0-15.15) ...
92s autopkgtest [18:37:40]: rebooting testbed after setup commands that affected boot
119s autopkgtest [18:38:07]: testbed running kernel: Linux 6.15.0-4-generic #4-Ubuntu SMP Fri Jul 4 14:38:10 UTC 2025
122s autopkgtest [18:38:10]: @@@@@@@@@@@@@@@@@@@@ apt-source cockpit-podman
125s Get:1 http://ftpmaster.internal/ubuntu questing/universe cockpit-podman 108-1 (dsc) [2008 B]
125s Get:2 http://ftpmaster.internal/ubuntu questing/universe cockpit-podman 108-1 (tar) [1032 kB]
125s Get:3 http://ftpmaster.internal/ubuntu questing/universe cockpit-podman 108-1 (diff) [5824 B]
125s gpgv: Signature made Sat Jun 28 05:55:51 2025 UTC
125s gpgv: using RSA key 6C4B878B7E631F160557C3CDEE7BDDE4B86B5713
125s gpgv: Can't check signature: No public key
125s dpkg-source: warning: cannot verify inline signature for ./cockpit-podman_108-1.dsc: no acceptable signature found
125s autopkgtest [18:38:13]: testing package cockpit-podman version 108-1
126s autopkgtest [18:38:14]: build not needed
127s autopkgtest [18:38:15]: test smoke: preparing testbed
127s Reading package lists...
127s Building dependency tree...
127s Reading state information...
127s Solving dependencies...
127s The following NEW packages will be installed:
127s cockpit-bridge cockpit-podman cockpit-ws conmon crun dconf-gsettings-backend
127s dconf-service glib-networking glib-networking-common
127s glib-networking-services golang-github-containers-common
127s golang-github-containers-image gsettings-desktop-schemas libdconf1
127s libduktape207 libproxy1v5 libsubid5 libyajl2 netavark podman
127s 0 upgraded, 20 newly installed, 0 to remove and 0 not upgraded.
127s Need to get 31.4 MB of archives.
127s After this operation, 115 MB of additional disk space will be used.
127s Get:1 http://ftpmaster.internal/ubuntu questing/universe ppc64el cockpit-bridge all 339-1 [389 kB]
128s Get:2 http://ftpmaster.internal/ubuntu questing/universe ppc64el conmon ppc64el 2.1.12-4 [37.9 kB]
128s Get:3 http://ftpmaster.internal/ubuntu questing/main ppc64el libyajl2 ppc64el 2.1.0-5build1 [23.5 kB]
128s Get:4 http://ftpmaster.internal/ubuntu questing/universe ppc64el crun ppc64el 1.20-1syncable1 [614 kB]
128s Get:5 http://ftpmaster.internal/ubuntu questing/universe ppc64el netavark ppc64el 1.14.0-2 [4932 kB]
132s Get:6 http://ftpmaster.internal/ubuntu questing/universe ppc64el golang-github-containers-image all 5.34.2-1 [34.6 kB]
132s Get:7 http://ftpmaster.internal/ubuntu questing/universe ppc64el golang-github-containers-common all 0.62.2+ds1-2 [44.5 kB]
132s Get:8 http://ftpmaster.internal/ubuntu questing/main ppc64el libsubid5 ppc64el 1:4.17.4-2ubuntu1 [30.2 kB]
132s Get:9 http://ftpmaster.internal/ubuntu questing-proposed/universe ppc64el podman ppc64el 5.4.2+ds1-2 [23.2 MB]
143s Get:10 http://ftpmaster.internal/ubuntu questing/universe ppc64el cockpit-podman all 108-1 [563 kB]
143s Get:11 http://ftpmaster.internal/ubuntu questing/main ppc64el libduktape207 ppc64el 2.7.0+tests-0ubuntu3 [158 kB]
143s Get:12 http://ftpmaster.internal/ubuntu questing/main ppc64el libproxy1v5 ppc64el 0.5.9-1 [29.6 kB]
143s Get:13 http://ftpmaster.internal/ubuntu questing/main ppc64el glib-networking-common all 2.80.1-1 [6680 B]
143s Get:14 http://ftpmaster.internal/ubuntu questing/main ppc64el glib-networking-services ppc64el 2.80.1-1 [13.5 kB]
143s Get:15 http://ftpmaster.internal/ubuntu questing/main ppc64el libdconf1 ppc64el 0.40.0-5 [43.7 kB]
143s Get:16 http://ftpmaster.internal/ubuntu questing/main ppc64el dconf-service ppc64el 0.40.0-5 [30.8 kB]
143s Get:17 http://ftpmaster.internal/ubuntu questing/main ppc64el dconf-gsettings-backend ppc64el 0.40.0-5 [26.0 kB]
143s Get:18 http://ftpmaster.internal/ubuntu questing/main ppc64el gsettings-desktop-schemas all 48.0-1ubuntu1 [37.6 kB]
143s Get:19 http://ftpmaster.internal/ubuntu questing/main ppc64el glib-networking ppc64el 2.80.1-1 [73.0 kB]
143s Get:20 http://ftpmaster.internal/ubuntu questing/universe ppc64el cockpit-ws ppc64el 339-1 [1061 kB]
145s Fetched 31.4 MB in 18s (1788 kB/s)
145s Selecting previously unselected package cockpit-bridge.
145s (Reading database ...
(Reading database ... 5%
(Reading database ... 10%
(Reading database ... 15%
(Reading database ... 20%
(Reading database ... 25%
(Reading database ... 30%
(Reading database ... 35%
(Reading database ... 40%
(Reading database ... 45%
(Reading database ... 50%
(Reading database ... 55%
(Reading database ... 60%
(Reading database ... 65%
(Reading database ... 70%
(Reading database ... 75%
(Reading database ... 80%
(Reading database ... 85%
(Reading database ... 90%
(Reading database ... 95%
(Reading database ... 100%
(Reading database ... 114514 files and directories currently installed.)
145s Preparing to unpack .../00-cockpit-bridge_339-1_all.deb ...
145s Unpacking cockpit-bridge (339-1) ...
145s Selecting previously unselected package conmon.
145s Preparing to unpack .../01-conmon_2.1.12-4_ppc64el.deb ...
145s Unpacking conmon (2.1.12-4) ...
145s Selecting previously unselected package libyajl2:ppc64el.
145s Preparing to unpack .../02-libyajl2_2.1.0-5build1_ppc64el.deb ...
145s Unpacking libyajl2:ppc64el (2.1.0-5build1) ...
145s Selecting previously unselected package crun.
145s Preparing to unpack .../03-crun_1.20-1syncable1_ppc64el.deb ...
145s Unpacking crun (1.20-1syncable1) ...
145s Selecting previously unselected package netavark.
145s Preparing to unpack .../04-netavark_1.14.0-2_ppc64el.deb ...
145s Unpacking netavark (1.14.0-2) ...
145s Selecting previously unselected package golang-github-containers-image.
145s Preparing to unpack .../05-golang-github-containers-image_5.34.2-1_all.deb ...
145s Unpacking golang-github-containers-image (5.34.2-1) ...
145s Selecting previously unselected package golang-github-containers-common.
145s Preparing to unpack .../06-golang-github-containers-common_0.62.2+ds1-2_all.deb ...
145s Unpacking golang-github-containers-common (0.62.2+ds1-2) ...
145s Selecting previously unselected package libsubid5:ppc64el.
145s Preparing to unpack .../07-libsubid5_1%3a4.17.4-2ubuntu1_ppc64el.deb ...
145s Unpacking libsubid5:ppc64el (1:4.17.4-2ubuntu1) ...
145s Selecting previously unselected package podman.
145s Preparing to unpack .../08-podman_5.4.2+ds1-2_ppc64el.deb ...
145s Unpacking podman (5.4.2+ds1-2) ...
146s Selecting previously unselected package cockpit-podman.
146s Preparing to unpack .../09-cockpit-podman_108-1_all.deb ...
146s Unpacking cockpit-podman (108-1) ...
146s Selecting previously unselected package libduktape207:ppc64el.
146s Preparing to unpack .../10-libduktape207_2.7.0+tests-0ubuntu3_ppc64el.deb ...
146s Unpacking libduktape207:ppc64el (2.7.0+tests-0ubuntu3) ...
146s Selecting previously unselected package libproxy1v5:ppc64el.
146s Preparing to unpack .../11-libproxy1v5_0.5.9-1_ppc64el.deb ...
146s Unpacking libproxy1v5:ppc64el (0.5.9-1) ...
146s Selecting previously unselected package glib-networking-common.
146s Preparing to unpack .../12-glib-networking-common_2.80.1-1_all.deb ...
146s Unpacking glib-networking-common (2.80.1-1) ...
146s Selecting previously unselected package glib-networking-services.
146s Preparing to unpack .../13-glib-networking-services_2.80.1-1_ppc64el.deb ...
146s Unpacking glib-networking-services (2.80.1-1) ...
146s Selecting previously unselected package libdconf1:ppc64el.
146s Preparing to unpack .../14-libdconf1_0.40.0-5_ppc64el.deb ...
146s Unpacking libdconf1:ppc64el (0.40.0-5) ...
146s Selecting previously unselected package dconf-service.
146s Preparing to unpack .../15-dconf-service_0.40.0-5_ppc64el.deb ...
146s Unpacking dconf-service (0.40.0-5) ...
146s Selecting previously unselected package dconf-gsettings-backend:ppc64el.
146s Preparing to unpack .../16-dconf-gsettings-backend_0.40.0-5_ppc64el.deb ...
146s Unpacking dconf-gsettings-backend:ppc64el (0.40.0-5) ...
146s Selecting previously unselected package gsettings-desktop-schemas.
146s Preparing to unpack .../17-gsettings-desktop-schemas_48.0-1ubuntu1_all.deb ...
146s Unpacking gsettings-desktop-schemas (48.0-1ubuntu1) ...
146s Selecting previously unselected package glib-networking:ppc64el.
146s Preparing to unpack .../18-glib-networking_2.80.1-1_ppc64el.deb ...
146s Unpacking glib-networking:ppc64el (2.80.1-1) ...
146s Selecting previously unselected package cockpit-ws.
146s Preparing to unpack .../19-cockpit-ws_339-1_ppc64el.deb ...
146s Unpacking cockpit-ws (339-1) ...
146s Setting up libyajl2:ppc64el (2.1.0-5build1) ...
146s Setting up libsubid5:ppc64el (1:4.17.4-2ubuntu1) ...
146s Setting up libdconf1:ppc64el (0.40.0-5) ...
146s Setting up golang-github-containers-image (5.34.2-1) ...
146s Setting up conmon (2.1.12-4) ...
146s Setting up netavark (1.14.0-2) ...
146s Created symlink '/etc/systemd/system/default.target.wants/netavark-dhcp-proxy.service' → '/usr/lib/systemd/system/netavark-dhcp-proxy.service'.
146s Created symlink '/etc/systemd/system/sockets.target.wants/netavark-dhcp-proxy.socket' → '/usr/lib/systemd/system/netavark-dhcp-proxy.socket'.
146s Created symlink '/etc/systemd/system/firewalld.service.wants/netavark-firewalld-reload.service' → '/usr/lib/systemd/system/netavark-firewalld-reload.service'.
146s Unit /usr/lib/systemd/system/netavark-firewalld-reload.service is added as a dependency to a non-existent unit firewalld.service.
147s Setting up cockpit-bridge (339-1) ...
147s Setting up libduktape207:ppc64el (2.7.0+tests-0ubuntu3) ...
147s Setting up golang-github-containers-common (0.62.2+ds1-2) ...
147s Setting up glib-networking-common (2.80.1-1) ...
147s Setting up libproxy1v5:ppc64el (0.5.9-1) ...
147s Setting up crun (1.20-1syncable1) ...
147s Setting up podman (5.4.2+ds1-2) ...
148s Setting up dconf-service (0.40.0-5) ...
148s Setting up glib-networking-services (2.80.1-1) ...
148s Setting up cockpit-podman (108-1) ...
148s Setting up dconf-gsettings-backend:ppc64el (0.40.0-5) ...
148s Setting up gsettings-desktop-schemas (48.0-1ubuntu1) ...
148s Processing triggers for libc-bin (2.41-6ubuntu2) ...
148s Processing triggers for man-db (2.13.1-1) ...
149s Processing triggers for libglib2.0-0t64:ppc64el (2.84.3-1) ...
150s Setting up glib-networking:ppc64el (2.80.1-1) ...
150s Setting up cockpit-ws (339-1) ...
150s Created symlink '/etc/systemd/system/sockets.target.wants/cockpit.socket' → '/usr/lib/systemd/system/cockpit.socket'.
151s autopkgtest [18:38:39]: test smoke: [-----------------------
151s * bridge works and has expected packages
151s base1 /usr/share/cockpit/base1
151s podman Podman containers /usr/share/cockpit/podman
151s static /usr/share/cockpit/static
151s none
151s * socket unit is set up correctly, login page works
152s {"csrf-token":"1e5a8d33b8e1f411b444687ef65b2e023a5fb708fd79c806f6e25c47a652ae04"}
152s * load podman page
152s output does not match '
0x0000000000000000
152s Jul 08 18:37:59 autopkgtest kernel: MEM 0x0000200080000000..0x00002000ffffffff -> 0x0000000080000000
152s Jul 08 18:37:59 autopkgtest kernel: MEM 0x0000210000000000..0x000021ffffffffff -> 0x0000210000000000
152s Jul 08 18:37:59 autopkgtest kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns
152s Jul 08 18:37:59 autopkgtest kernel: posixtimers hash table entries: 1024 (order: -2, 16384 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: futex hash table entries: 512 (order: 0, 65536 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: pinctrl core: initialized pinctrl subsystem
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family
152s Jul 08 18:37:59 autopkgtest kernel: audit: initializing netlink subsys (disabled)
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=2000 audit(1751999875.060:1): state=initialized audit_enabled=0 res=1
152s Jul 08 18:37:59 autopkgtest kernel: thermal_sys: Registered thermal governor 'fair_share'
152s Jul 08 18:37:59 autopkgtest kernel: thermal_sys: Registered thermal governor 'bang_bang'
152s Jul 08 18:37:59 autopkgtest kernel: thermal_sys: Registered thermal governor 'step_wise'
152s Jul 08 18:37:59 autopkgtest kernel: thermal_sys: Registered thermal governor 'user_space'
152s Jul 08 18:37:59 autopkgtest kernel: thermal_sys: Registered thermal governor 'power_allocator'
152s Jul 08 18:37:59 autopkgtest kernel: cpuidle: using governor ladder
152s Jul 08 18:37:59 autopkgtest kernel: cpuidle: using governor menu
152s Jul 08 18:37:59 autopkgtest kernel: RTAS daemon started
152s Jul 08 18:37:59 autopkgtest kernel: pstore: Using crash dump compression: deflate
152s Jul 08 18:37:59 autopkgtest kernel: pstore: Registered nvram as persistent store backend
152s Jul 08 18:37:59 autopkgtest kernel: EEH: pSeries platform initialized
152s Jul 08 18:37:59 autopkgtest kernel: kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.
152s Jul 08 18:37:59 autopkgtest kernel: HugeTLB: allocation took 0ms with hugepage_allocation_threads=1
152s Jul 08 18:37:59 autopkgtest kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
152s Jul 08 18:37:59 autopkgtest kernel: HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page
152s Jul 08 18:37:59 autopkgtest kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
152s Jul 08 18:37:59 autopkgtest kernel: HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page
152s Jul 08 18:37:59 autopkgtest kernel: iommu: Default domain type: Translated
152s Jul 08 18:37:59 autopkgtest kernel: iommu: DMA domain TLB invalidation policy: strict mode
152s Jul 08 18:37:59 autopkgtest kernel: SCSI subsystem initialized
152s Jul 08 18:37:59 autopkgtest kernel: libata version 3.00 loaded.
152s Jul 08 18:37:59 autopkgtest kernel: usbcore: registered new interface driver usbfs
152s Jul 08 18:37:59 autopkgtest kernel: usbcore: registered new interface driver hub
152s Jul 08 18:37:59 autopkgtest kernel: usbcore: registered new device driver usb
152s Jul 08 18:37:59 autopkgtest kernel: pps_core: LinuxPPS API ver. 1 registered
152s Jul 08 18:37:59 autopkgtest kernel: pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti
152s Jul 08 18:37:59 autopkgtest kernel: PTP clock support registered
152s Jul 08 18:37:59 autopkgtest kernel: EDAC MC: Ver: 3.0.0
152s Jul 08 18:37:59 autopkgtest kernel: NetLabel: Initializing
152s Jul 08 18:37:59 autopkgtest kernel: NetLabel: domain hash size = 128
152s Jul 08 18:37:59 autopkgtest kernel: NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO
152s Jul 08 18:37:59 autopkgtest kernel: NetLabel: unlabeled traffic allowed by default
152s Jul 08 18:37:59 autopkgtest kernel: mctp: management component transport protocol core
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_MCTP protocol family
152s Jul 08 18:37:59 autopkgtest kernel: PCI: Probing PCI hardware
152s Jul 08 18:37:59 autopkgtest kernel: PCI host bridge to bus 0000:00
152s Jul 08 18:37:59 autopkgtest kernel: pci_bus 0000:00: root bus resource [io 0x10000-0x1ffff] (bus address [0x0000-0xffff])
152s Jul 08 18:37:59 autopkgtest kernel: pci_bus 0000:00: root bus resource [mem 0x200080000000-0x2000ffffffff] (bus address [0x80000000-0xffffffff])
152s Jul 08 18:37:59 autopkgtest kernel: pci_bus 0000:00: root bus resource [mem 0x210000000000-0x21ffffffffff 64bit]
152s Jul 08 18:37:59 autopkgtest kernel: pci_bus 0000:00: root bus resource [bus 00-ff]
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:01.0: No hypervisor support for SR-IOV on this device, IOV BARs disabled.
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:02.0: No hypervisor support for SR-IOV on this device, IOV BARs disabled.
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:03.0: No hypervisor support for SR-IOV on this device, IOV BARs disabled.
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:04.0: No hypervisor support for SR-IOV on this device, IOV BARs disabled.
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:05.0: No hypervisor support for SR-IOV on this device, IOV BARs disabled.
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:06.0: No hypervisor support for SR-IOV on this device, IOV BARs disabled.
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:07.0: No hypervisor support for SR-IOV on this device, IOV BARs disabled.
152s Jul 08 18:37:59 autopkgtest kernel: IOMMU table initialized, virtual merging enabled
152s Jul 08 18:37:59 autopkgtest kernel: PCI 0000:00 Cannot reserve Legacy IO [io 0x10000-0x10fff]
152s Jul 08 18:37:59 autopkgtest kernel: pci_bus 0000:00: resource 4 [io 0x10000-0x1ffff]
152s Jul 08 18:37:59 autopkgtest kernel: pci_bus 0000:00: resource 5 [mem 0x200080000000-0x2000ffffffff]
152s Jul 08 18:37:59 autopkgtest kernel: pci_bus 0000:00: resource 6 [mem 0x210000000000-0x21ffffffffff 64bit]
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:01.0: ibm,query-pe-dma-windows(2026) 800 8000000 20000000 returned 0, lb=80000000 ps=7 wn=1
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:01.0: Adding to iommu group 0
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:02.0: Adding to iommu group 0
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:03.0: Adding to iommu group 0
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:04.0: Adding to iommu group 0
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:05.0: Adding to iommu group 0
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:06.0: Adding to iommu group 0
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:07.0: Adding to iommu group 0
152s Jul 08 18:37:59 autopkgtest kernel: EEH: No capable adapters found: recovery disabled.
152s Jul 08 18:37:59 autopkgtest kernel: PCI: Probing PCI hardware done
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:07.0: vgaarb: setting as boot VGA device
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:07.0: vgaarb: bridge control possible
152s Jul 08 18:37:59 autopkgtest kernel: pci 0000:00:07.0: vgaarb: VGA device added: decodes=io+mem,owns=mem,locks=none
152s Jul 08 18:37:59 autopkgtest kernel: vgaarb: loaded
152s Jul 08 18:37:59 autopkgtest kernel: clocksource: Switched to clocksource timebase
152s Jul 08 18:37:59 autopkgtest kernel: VFS: Disk quotas dquot_6.6.0
152s Jul 08 18:37:59 autopkgtest kernel: VFS: Dquot-cache hash table entries: 8192 (order 0, 65536 bytes)
152s Jul 08 18:37:59 autopkgtest kernel: AppArmor: AppArmor Filesystem Enabled
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_INET protocol family
152s Jul 08 18:37:59 autopkgtest kernel: IP idents hash table entries: 65536 (order: 3, 524288 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: tcp_listen_portaddr_hash hash table entries: 4096 (order: 0, 65536 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: Table-perturb hash table entries: 65536 (order: 2, 262144 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: TCP established hash table entries: 32768 (order: 2, 262144 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: TCP bind hash table entries: 32768 (order: 4, 1048576 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: TCP: Hash tables configured (established 32768 bind 32768)
152s Jul 08 18:37:59 autopkgtest kernel: MPTCP token hash table entries: 4096 (order: 0, 98304 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: UDP hash table entries: 2048 (order: 1, 131072 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: UDP-Lite hash table entries: 2048 (order: 1, 131072 bytes, linear)
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_XDP protocol family
152s Jul 08 18:37:59 autopkgtest kernel: PCI: CLS 0 bytes, default 128
152s Jul 08 18:37:59 autopkgtest kernel: Trying to unpack rootfs image as initramfs...
152s Jul 08 18:37:59 autopkgtest kernel: Initialise system trusted keyrings
152s Jul 08 18:37:59 autopkgtest kernel: Key type blacklist registered
152s Jul 08 18:37:59 autopkgtest kernel: workingset: timestamp_bits=38 max_order=16 bucket_order=0
152s Jul 08 18:37:59 autopkgtest kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher
152s Jul 08 18:37:59 autopkgtest kernel: fuse: init (API version 7.43)
152s Jul 08 18:37:59 autopkgtest kernel: integrity: Platform Keyring initialized
152s Jul 08 18:37:59 autopkgtest kernel: integrity: Machine keyring initialized
152s Jul 08 18:37:59 autopkgtest kernel: Key type asymmetric registered
152s Jul 08 18:37:59 autopkgtest kernel: Asymmetric key parser 'x509' registered
152s Jul 08 18:37:59 autopkgtest kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 243)
152s Jul 08 18:37:59 autopkgtest kernel: io scheduler mq-deadline registered
152s Jul 08 18:37:59 autopkgtest kernel: ledtrig-cpu: registered to indicate activity on CPUs
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:01.0: enabling device (0100 -> 0103)
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:01.0: ibm,query-pe-dma-windows(2026) 800 8000000 20000000 returned 0, lb=80000000 ps=7 wn=1
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:01.0: ibm,create-pe-dma-window(2027) 800 8000000 20000000 18 0 returned -3 (liobn = 0x0 starting addr = 0 0)
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:01.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 1
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:01.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:03.0: enabling device (0100 -> 0103)
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:03.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:03.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:04.0: enabling device (0100 -> 0103)
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:04.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:04.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:05.0: enabling device (0100 -> 0103)
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:05.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:05.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:06.0: enabling device (0100 -> 0103)
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:06.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: virtio-pci 0000:00:06.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: printk: legacy console [hvc0] enabled
152s Jul 08 18:37:59 autopkgtest kernel: Serial: 8250/16550 driver, 32 ports, IRQ sharing enabled
152s Jul 08 18:37:59 autopkgtest kernel: Freeing initrd memory: 58112K
152s Jul 08 18:37:59 autopkgtest kernel: Non-volatile memory driver v1.3
152s Jul 08 18:37:59 autopkgtest kernel: Linux agpgart interface v0.103
152s Jul 08 18:37:59 autopkgtest kernel: loop: module loaded
152s Jul 08 18:37:59 autopkgtest kernel: virtio_blk virtio2: 2/0/0 default/read/poll queues
152s Jul 08 18:37:59 autopkgtest kernel: virtio_blk virtio2: [vda] 41943040 512-byte logical blocks (21.5 GB/20.0 GiB)
152s Jul 08 18:37:59 autopkgtest kernel: vda: vda1 vda2
152s Jul 08 18:37:59 autopkgtest kernel: tun: Universal TUN/TAP device driver, 1.6
152s Jul 08 18:37:59 autopkgtest kernel: PPP generic driver version 2.4.2
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: xHCI Host Controller
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: new USB bus registered, assigned bus number 1
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: lsa_required: 0, lsa_enabled: 0, direct mapping: 0
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: hcc params 0x00087001 hci version 0x100 quirks 0x0000000000000010
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: xHCI Host Controller
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: new USB bus registered, assigned bus number 2
152s Jul 08 18:37:59 autopkgtest kernel: xhci_hcd 0000:00:02.0: Host supports USB 3.0 SuperSpeed
152s Jul 08 18:37:59 autopkgtest kernel: usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 6.15
152s Jul 08 18:37:59 autopkgtest kernel: usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1
152s Jul 08 18:37:59 autopkgtest kernel: usb usb1: Product: xHCI Host Controller
152s Jul 08 18:37:59 autopkgtest kernel: usb usb1: Manufacturer: Linux 6.15.0-4-generic xhci-hcd
152s Jul 08 18:37:59 autopkgtest kernel: usb usb1: SerialNumber: 0000:00:02.0
152s Jul 08 18:37:59 autopkgtest kernel: hub 1-0:1.0: USB hub found
152s Jul 08 18:37:59 autopkgtest kernel: hub 1-0:1.0: 4 ports detected
152s Jul 08 18:37:59 autopkgtest kernel: usb usb2: We don't know the algorithms for LPM for this host, disabling LPM.
152s Jul 08 18:37:59 autopkgtest kernel: usb usb2: New USB device found, idVendor=1d6b, idProduct=0003, bcdDevice= 6.15
152s Jul 08 18:37:59 autopkgtest kernel: usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1
152s Jul 08 18:37:59 autopkgtest kernel: usb usb2: Product: xHCI Host Controller
152s Jul 08 18:37:59 autopkgtest kernel: usb usb2: Manufacturer: Linux 6.15.0-4-generic xhci-hcd
152s Jul 08 18:37:59 autopkgtest kernel: usb usb2: SerialNumber: 0000:00:02.0
152s Jul 08 18:37:59 autopkgtest kernel: hub 2-0:1.0: USB hub found
152s Jul 08 18:37:59 autopkgtest kernel: hub 2-0:1.0: 4 ports detected
152s Jul 08 18:37:59 autopkgtest kernel: mousedev: PS/2 mouse device common for all mice
152s Jul 08 18:37:59 autopkgtest kernel: rtc-generic rtc-generic: registered as rtc0
152s Jul 08 18:37:59 autopkgtest kernel: rtc-generic rtc-generic: setting system clock to 2025-07-08T18:37:56 UTC (1751999876)
152s Jul 08 18:37:59 autopkgtest kernel: i2c_dev: i2c /dev entries driver
152s Jul 08 18:37:59 autopkgtest kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.
152s Jul 08 18:37:59 autopkgtest kernel: device-mapper: uevent: version 1.0.3
152s Jul 08 18:37:59 autopkgtest kernel: device-mapper: ioctl: 4.49.0-ioctl (2025-01-17) initialised: dm-devel@lists.linux.dev
152s Jul 08 18:37:59 autopkgtest kernel: pseries_idle_driver registered
152s Jul 08 18:37:59 autopkgtest kernel: drop_monitor: Initializing network drop monitor service
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_INET6 protocol family
152s Jul 08 18:37:59 autopkgtest kernel: Segment Routing with IPv6
152s Jul 08 18:37:59 autopkgtest kernel: In-situ OAM (IOAM) with IPv6
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_PACKET protocol family
152s Jul 08 18:37:59 autopkgtest kernel: Key type dns_resolver registered
152s Jul 08 18:37:59 autopkgtest kernel: secvar-sysfs: Failed to retrieve secvar operations
152s Jul 08 18:37:59 autopkgtest kernel: registered taskstats version 1
152s Jul 08 18:37:59 autopkgtest kernel: Loading compiled-in X.509 certificates
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Build time autogenerated kernel key: fc1abe5e7f97fe6dbeff78bb3df486d88a0a7e76'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Live Patch Signing 2025 Kmod: d541cef61dc7e793b7eb7e899970a2eef0b5dc8c'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Live Patch Signing: 14df34d1a87cf37625abec039ef2bf521249b969'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Kernel Module Signing: 88f752e560a1e0737e31163a466ad7b70a850c19'
152s Jul 08 18:37:59 autopkgtest kernel: blacklist: Loading compiled-in revocation X.509 certificates
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing: 61482aa2830d0ab2ad5af10b7250da9033ddcef0'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing (2017): 242ade75ac4a15e50d50c84b0d45ff3eae707a03'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing (ESM 2018): 365188c1d374d6b07c3c8f240f8ef722433d6a8b'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing (2019): c0746fd6c5da3ae827864651ad66ae47fe24b3e8'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing (2021 v1): a8d54bbb3825cfb94fa13c9f8a594a195c107b8d'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing (2021 v2): 4cf046892d6fd3c9a5b03f98d845f90851dc6a8c'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing (2021 v3): 100437bb6de6e469b581e61cd66bce3ef4ed53af'
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Canonical Ltd. Secure Boot Signing (Ubuntu Core 2019): c1d57b8f6b743f23ee41f4f7ee292f06eecadfb9'
152s Jul 08 18:37:59 autopkgtest kernel: Demotion targets for Node 0: null
152s Jul 08 18:37:59 autopkgtest kernel: Key type .fscrypt registered
152s Jul 08 18:37:59 autopkgtest kernel: Key type fscrypt-provisioning registered
152s Jul 08 18:37:59 autopkgtest kernel: Key type big_key registered
152s Jul 08 18:37:59 autopkgtest kernel: Key type encrypted registered
152s Jul 08 18:37:59 autopkgtest kernel: AppArmor: AppArmor sha256 policy hashing enabled
152s Jul 08 18:37:59 autopkgtest kernel: Secure boot mode disabled
152s Jul 08 18:37:59 autopkgtest kernel: ima: No TPM chip found, activating TPM-bypass!
152s Jul 08 18:37:59 autopkgtest kernel: Loading compiled-in module X.509 certificates
152s Jul 08 18:37:59 autopkgtest kernel: Loaded X.509 cert 'Build time autogenerated kernel key: fc1abe5e7f97fe6dbeff78bb3df486d88a0a7e76'
152s Jul 08 18:37:59 autopkgtest kernel: ima: Allocated hash algorithm: sha256
152s Jul 08 18:37:59 autopkgtest kernel: Secure boot mode disabled
152s Jul 08 18:37:59 autopkgtest kernel: Trusted boot mode disabled
152s Jul 08 18:37:59 autopkgtest kernel: ima: No architecture policies found
152s Jul 08 18:37:59 autopkgtest kernel: evm: Initialising EVM extended attributes:
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.selinux
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.SMACK64
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.SMACK64EXEC
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.SMACK64TRANSMUTE
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.SMACK64MMAP
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.apparmor
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.ima
152s Jul 08 18:37:59 autopkgtest kernel: evm: security.capability
152s Jul 08 18:37:59 autopkgtest kernel: evm: HMAC attrs: 0x1
152s Jul 08 18:37:59 autopkgtest kernel: SED: plpks not available
152s Jul 08 18:37:59 autopkgtest kernel: clk: Disabling unused clocks
152s Jul 08 18:37:59 autopkgtest kernel: PM: genpd: Disabling unused power domains
152s Jul 08 18:37:59 autopkgtest kernel: integrity: Unable to open file: /etc/keys/x509_evm.der (-2)
152s Jul 08 18:37:59 autopkgtest kernel: Freeing unused kernel image (initmem) memory: 8768K
152s Jul 08 18:37:59 autopkgtest kernel: Checked W+X mappings: passed, no W+X pages found
152s Jul 08 18:37:59 autopkgtest kernel: Run /init as init process
152s Jul 08 18:37:59 autopkgtest kernel: with arguments:
152s Jul 08 18:37:59 autopkgtest kernel: /init
152s Jul 08 18:37:59 autopkgtest kernel: earlyprintk
152s Jul 08 18:37:59 autopkgtest kernel: with environment:
152s Jul 08 18:37:59 autopkgtest kernel: HOME=/
152s Jul 08 18:37:59 autopkgtest kernel: TERM=linux
152s Jul 08 18:37:59 autopkgtest kernel: BOOT_IMAGE=/boot/vmlinux-6.15.0-4-generic
152s Jul 08 18:37:59 autopkgtest kernel: virtio_net virtio0 enp0s1: renamed from eth0
152s Jul 08 18:37:59 autopkgtest kernel: random: crng init done
152s Jul 08 18:37:59 autopkgtest kernel: [drm] Found bochs VGA, ID 0xb0c5.
152s Jul 08 18:37:59 autopkgtest kernel: [drm] Framebuffer size 16384 kB @ 0x200081000000, mmio @ 0x200082000000.
152s Jul 08 18:37:59 autopkgtest kernel: [drm] Initialized bochs-drm 1.0.0 for 0000:00:07.0 on minor 0
152s Jul 08 18:37:59 autopkgtest kernel: fbcon: Deferring console take-over
152s Jul 08 18:37:59 autopkgtest kernel: bochs-drm 0000:00:07.0: [drm] fb0: bochs-drmdrmfb frame buffer device
152s Jul 08 18:37:59 autopkgtest kernel: ibmvscsi 2000: SRP_VERSION: 16.a
152s Jul 08 18:37:59 autopkgtest kernel: ibmvscsi 2000: Maximum ID: 64 Maximum LUN: 32 Maximum Channel: 3
152s Jul 08 18:37:59 autopkgtest kernel: scsi host0: IBM POWER Virtual SCSI Adapter 1.5.9
152s Jul 08 18:37:59 autopkgtest kernel: ibmvscsi 2000: partner initialization complete
152s Jul 08 18:37:59 autopkgtest kernel: ibmvscsi 2000: host srp version: 16.a, host partition qemu (0), OS 2, max io 2097152
152s Jul 08 18:37:59 autopkgtest kernel: ibmvscsi 2000: sent SRP login
152s Jul 08 18:37:59 autopkgtest kernel: ibmvscsi 2000: SRP_LOGIN succeeded
152s Jul 08 18:37:59 autopkgtest kernel: scsi 0:0:0:0: CD-ROM QEMU QEMU CD-ROM 2.5+ PQ: 0 ANSI: 5
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-1: new high-speed USB device number 2 using xhci_hcd
152s Jul 08 18:37:59 autopkgtest kernel: sr 0:0:0:0: Power-on or device reset occurred
152s Jul 08 18:37:59 autopkgtest kernel: sr 0:0:0:0: [sr0] scsi3-mmc drive: 16x/50x cd/rw xa/form2 cdda tray
152s Jul 08 18:37:59 autopkgtest kernel: cdrom: Uniform CD-ROM driver Revision: 3.20
152s Jul 08 18:37:59 autopkgtest kernel: sr 0:0:0:0: Attached scsi CD-ROM sr0
152s Jul 08 18:37:59 autopkgtest kernel: sr 0:0:0:0: Attached scsi generic sg0 type 5
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-1: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.00
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-1: New USB device strings: Mfr=1, Product=4, SerialNumber=11
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-1: Product: QEMU USB Keyboard
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-1: Manufacturer: QEMU
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-1: SerialNumber: 68284-pci@800000020000000:02.0-1
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-2: new high-speed USB device number 3 using xhci_hcd
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-2: New USB device found, idVendor=0627, idProduct=0001, bcdDevice= 0.00
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-2: New USB device strings: Mfr=1, Product=2, SerialNumber=9
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-2: Product: QEMU USB Mouse
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-2: Manufacturer: QEMU
152s Jul 08 18:37:59 autopkgtest kernel: usb 1-2: SerialNumber: 89126-pci@800000020000000:02.0-2
152s Jul 08 18:37:59 autopkgtest kernel: hid: raw HID events driver (C) Jiri Kosina
152s Jul 08 18:37:59 autopkgtest kernel: usbcore: registered new interface driver usbhid
152s Jul 08 18:37:59 autopkgtest kernel: usbhid: USB HID core driver
152s Jul 08 18:37:59 autopkgtest kernel: input: QEMU QEMU USB Keyboard as /devices/pci0000:00/0000:00:02.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input0
152s Jul 08 18:37:59 autopkgtest kernel: hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:02.0-1/input0
152s Jul 08 18:37:59 autopkgtest kernel: input: QEMU QEMU USB Mouse as /devices/pci0000:00/0000:00:02.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input1
152s Jul 08 18:37:59 autopkgtest kernel: hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Mouse] on usb-0000:00:02.0-2/input0
152s Jul 08 18:37:59 autopkgtest kernel: raid6: vpermxor8 gen() 22500 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: vpermxor4 gen() 19740 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: vpermxor2 gen() 16031 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: vpermxor1 gen() 13078 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: altivecx8 gen() 13734 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: altivecx4 gen() 13669 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: altivecx2 gen() 11167 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: altivecx1 gen() 8642 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: int64x8 gen() 7236 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: int64x4 gen() 8677 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: int64x2 gen() 6656 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: int64x1 gen() 5255 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: using algorithm vpermxor8 gen() 22500 MB/s
152s Jul 08 18:37:59 autopkgtest kernel: raid6: using intx1 recovery algorithm
152s Jul 08 18:37:59 autopkgtest kernel: xor: measuring software checksum speed
152s Jul 08 18:37:59 autopkgtest kernel: 8regs : 17474 MB/sec
152s Jul 08 18:37:59 autopkgtest kernel: 8regs_prefetch : 15604 MB/sec
152s Jul 08 18:37:59 autopkgtest kernel: 32regs : 17370 MB/sec
152s Jul 08 18:37:59 autopkgtest kernel: 32regs_prefetch : 15598 MB/sec
152s Jul 08 18:37:59 autopkgtest kernel: altivec : 18706 MB/sec
152s Jul 08 18:37:59 autopkgtest kernel: xor: using function: altivec (18706 MB/sec)
152s Jul 08 18:37:59 autopkgtest kernel: Btrfs loaded, zoned=yes, fsverity=yes
152s Jul 08 18:37:59 autopkgtest kernel: EXT4-fs (vda1): orphan cleanup on readonly fs
152s Jul 08 18:37:59 autopkgtest kernel: EXT4-fs (vda1): mounted filesystem cc18d838-3721-4f67-b9bc-edb63f4f5973 ro with ordered data mode. Quota mode: none.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Inserted module 'autofs4'
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd 257.7-1ubuntu1 running in system mode (+PAM +AUDIT +SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK +BTF -XKBCOMMON -UTMP +SYSVINIT +LIBARCHIVE)
152s Jul 08 18:37:59 autopkgtest systemd[1]: Detected virtualization kvm.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Detected architecture ppc64-le.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Hostname set to .
152s Jul 08 18:37:59 autopkgtest systemd[1]: bpf-restrict-fs: BPF LSM hook not enabled in the kernel, BPF LSM not supported.
152s Jul 08 18:37:59 autopkgtest kernel: NET: Registered PF_VSOCK protocol family
152s Jul 08 18:37:59 autopkgtest systemd[1]: Queued start job for default target graphical.target.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Created slice system-autopkgtest.slice - Slice /system/autopkgtest.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Created slice user.slice - User and Session Slice.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Expecting device dev-hvc0.device - /dev/hvc0...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target remote-fs.target - Remote File Systems.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target slices.target - Slice Units.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target swap.target - Swaps.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on syslog.socket - Syslog Socket.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-creds.socket - Credential Encryption/Decryption.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-initctl.socket - initctl Compatibility Named Pipe.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log).
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-journald.socket - Journal Sockets.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting run-lock.mount - Legacy Locks Directory /run/lock...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-journald.service - Journal Service...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting keyboard-setup.service - Set the console keyboard layout...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting modprobe@dm_multipath.service - Load Kernel Module dm_multipath...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse...
152s Jul 08 18:37:59 autopkgtest systemd[1]: netplan-ovs-cleanup.service - OpenVSwitch configuration for cleanup was skipped because of an unmet condition check (ConditionFileIsExecutable=/usr/bin/ovs-vsctl).
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-fsck-root.service - File System Check on Root Device was skipped because of an unmet condition check (ConditionPathExists=!/run/initramfs/fsck-root).
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67).
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-udev-load-credentials.service - Load udev Rules from Credentials...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted run-lock.mount - Legacy Locks Directory /run/lock.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes.
152s Jul 08 18:37:59 autopkgtest systemd[1]: modprobe@configfs.service: Deactivated successfully.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs.
152s Jul 08 18:37:59 autopkgtest systemd[1]: modprobe@drm.service: Deactivated successfully.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm.
152s Jul 08 18:37:59 autopkgtest systemd[1]: modprobe@efi_pstore.service: Deactivated successfully.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore.
152s Jul 08 18:37:59 autopkgtest systemd[1]: modprobe@fuse.service: Deactivated successfully.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse.
152s Jul 08 18:37:59 autopkgtest systemd[1]: modprobe@dm_multipath.service: Deactivated successfully.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished modprobe@dm_multipath.service - Load Kernel Module dm_multipath.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-udev-load-credentials.service - Load udev Rules from Credentials.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System.
152s Jul 08 18:37:59 autopkgtest systemd-journald[286]: Collecting audit messages is disabled.
152s Jul 08 18:37:59 autopkgtest kernel: EXT4-fs (vda1): re-mounted cc18d838-3721-4f67-b9bc-edb63f4f5973 r/w.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting multipathd.service - Device-Mapper Multipath Device Controller...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting cloud-init-main.service - Cloud-init: Single Process...
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-hwdb-update.service - Rebuild Hardware Database was skipped because of an unmet condition check (ConditionNeedsUpdate=/etc).
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore).
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully.
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-sysusers.service - Create System Users was skipped because no trigger condition checks were met.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-resolved.service - Network Name Resolution...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-timesyncd.service - Network Time Synchronization...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished keyboard-setup.service - Set the console keyboard layout.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started multipathd.service - Device-Mapper Multipath Device Controller.
152s Jul 08 18:37:59 autopkgtest systemd-journald[286]: Journal started
152s Jul 08 18:37:59 autopkgtest systemd-journald[286]: Runtime Journal (/run/log/journal/9acd427571b540f48c6abce6b0f7a40e) is 5M, max 40.1M, 35.1M free.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started systemd-journald.service - Journal Service.
152s Jul 08 18:37:58 autopkgtest systemd-modules-load[306]: Module 'i2c_dev' is built in
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage...
152s Jul 08 18:37:59 autopkgtest multipathd[322]: multipathd v0.9.9: start up
152s Jul 08 18:37:59 autopkgtest multipathd[322]: reconfigure: setting up paths and maps
152s Jul 08 18:37:59 autopkgtest systemd-journald[286]: Time spent on flushing to /var/log/journal/9acd427571b540f48c6abce6b0f7a40e is 59.058ms for 495 entries.
152s Jul 08 18:37:59 autopkgtest systemd-journald[286]: System Journal (/var/log/journal/9acd427571b540f48c6abce6b0f7a40e) is 16M, max 1.9G, 1.9G free.
152s Jul 08 18:37:59 autopkgtest systemd-journald[286]: Received client request to flush runtime journal.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target local-fs.target - Local File Systems.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting apparmor.service - Load AppArmor profiles...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting console-setup.service - Set console font and keymap...
152s Jul 08 18:37:59 autopkgtest apparmor.systemd[365]: Restarting AppArmor
152s Jul 08 18:37:59 autopkgtest apparmor.systemd[365]: Reloading AppArmor profiles
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting plymouth-read-write.service - Tell Plymouth To Write Out Runtime Data...
152s Jul 08 18:37:59 autopkgtest systemd-resolved[328]: Positive Trust Anchors:
152s Jul 08 18:37:59 autopkgtest systemd-resolved[328]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d
152s Jul 08 18:37:59 autopkgtest systemd-resolved[328]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16
152s Jul 08 18:37:59 autopkgtest systemd-resolved[328]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-binfmt.service - Set Up Additional Binary Formats...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting ufw.service - Uncomplicated firewall...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished console-setup.service - Set console font and keymap.
152s Jul 08 18:37:59 autopkgtest systemd[1]: proc-sys-fs-binfmt_misc.automount: Got automount request for /proc/sys/fs/binfmt_misc, triggered by 368 (systemd-binfmt)
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished plymouth-read-write.service - Tell Plymouth To Write Out Runtime Data.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished ufw.service - Uncomplicated firewall.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started systemd-timesyncd.service - Network Time Synchronization.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target time-set.target - System Time Set.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories...
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.236:2): apparmor="STATUS" operation="profile_load" profile="unconfined" name="Discord" pid=392 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.236:3): apparmor="STATUS" operation="profile_load" profile="unconfined" name="1password" pid=391 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.244:4): apparmor="STATUS" operation="profile_load" profile="unconfined" name=4D6F6E676F444220436F6D70617373 pid=393 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.244:5): apparmor="STATUS" operation="profile_load" profile="unconfined" name="QtWebEngineProcess" pid=394 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest systemd-resolved[328]: Using system hostname 'autopkgtest'.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started systemd-resolved.service - Network Name Resolution.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups.
152s Jul 08 18:37:59 autopkgtest systemd-udevd[370]: Using default interface naming scheme 'v257'.
152s Jul 08 18:37:59 autopkgtest systemd-tmpfiles[390]: /usr/lib/tmpfiles.d/legacy.conf:14: Duplicate line for path "/run/lock", ignoring.
152s Jul 08 18:37:59 autopkgtest systemd-timesyncd[330]: Network configuration changed, trying to establish connection.
152s Jul 08 18:37:59 autopkgtest systemd-timesyncd[330]: Network configuration changed, trying to establish connection.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files.
152s Jul 08 18:37:59 autopkgtest systemd[1]: plymouth-start.service - Show Plymouth Boot Screen was skipped because of an unmet condition check (ConditionKernelCommandLine=splash).
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch.
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-ask-password-plymouth.path - Forward Password Requests to Plymouth Directory Watch was skipped because of an unmet condition check (ConditionPathExists=/run/plymouth/pid).
152s Jul 08 18:37:59 autopkgtest systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories.
152s Jul 08 18:37:59 autopkgtest systemd[1]: ldconfig.service - Rebuild Dynamic Linker Cache was skipped because no trigger condition checks were met.
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-firstboot.service - First Boot Wizard was skipped because of an unmet condition check (ConditionFirstBoot=yes).
152s Jul 08 18:37:59 autopkgtest systemd[1]: first-boot-complete.target - First Boot Complete was skipped because of an unmet condition check (ConditionFirstBoot=yes).
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-journal-catalog-update.service - Rebuild Journal Catalog was skipped because of an unmet condition check (ConditionNeedsUpdate=/var).
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-machine-id-commit.service - Save Transient machine-id to Disk was skipped because of an unmet condition check (ConditionPathIsMountPoint=/etc/machine-id).
152s Jul 08 18:37:59 autopkgtest systemd[1]: systemd-update-done.service - Update is Completed was skipped because no trigger condition checks were met.
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[417]: WARNING: SCSI device loop5 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[416]: WARNING: SCSI device loop0 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[419]: WARNING: SCSI device loop1 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[421]: WARNING: SCSI device loop2 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[420]: WARNING: SCSI device loop3 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[424]: WARNING: SCSI device loop6 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[429]: WARNING: SCSI device loop7 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest systemd[1]: Found device dev-hvc0.device - /dev/hvc0.
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[425]: WARNING: SCSI device loop4 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest (udev-worker)[411]: enp0s1: Could not set WakeOnLan to off, ignoring: Operation not supported
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[448]: WARNING: SCSI device vda has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest 55-scsi-sg3_id.rules[473]: WARNING: SCSI device sr0 has no device ID, consider changing .SCSI_ID_SERIAL_SRC in 00-scsi-sg3_config.rules
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.476:6): apparmor="STATUS" operation="profile_load" profile="unconfined" name="Xorg" pid=395 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.548:7): apparmor="STATUS" operation="profile_load" profile="unconfined" name="alsamixer" pid=396 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.560:8): apparmor="STATUS" operation="profile_load" profile="unconfined" name="balena-etcher" pid=528 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.648:9): apparmor="STATUS" operation="profile_load" profile="unconfined" name="bfdd" pid=531 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest systemd[1]: Listening on systemd-rfkill.socket - Load/Save RF Kill Switch Status /dev/rfkill Watch.
152s Jul 08 18:37:59 autopkgtest kernel: audit: type=1400 audit(1751999879.708:10): apparmor="STATUS" operation="profile_load" profile="unconfined" name="babeld" pid=524 comm="apparmor_parser"
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounting proc-sys-fs-binfmt_misc.mount - Arbitrary Executable File Formats File System...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Started cloud-init-main.service - Cloud-init: Single Process.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Starting cloud-init-local.service - Cloud-init: Local Stage (pre-network)...
152s Jul 08 18:37:59 autopkgtest systemd[1]: Mounted proc-sys-fs-binfmt_misc.mount - Arbitrary Executable File Formats File System.
152s Jul 08 18:37:59 autopkgtest systemd[1]: Finished systemd-binfmt.service - Set Up Additional Binary Formats.
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: Cloud-init v. 25.2~5g009c4cfd-0ubuntu1 running 'init-local' at Tue, 08 Jul 2025 18:38:00 +0000. Up 4.00 seconds.
152s Jul 08 18:38:00 autopkgtest kernel: ISO 9660 Extensions: Microsoft Joliet Level 3
152s Jul 08 18:38:00 autopkgtest kernel: ISO 9660 Extensions: RRIP_1991A
152s Jul 08 18:38:00 autopkgtest systemd[1]: run-cloud\x2dinit-tmp-tmpwp2ty6bc.mount: Deactivated successfully.
152s Jul 08 18:38:00 autopkgtest sh[662]: Completed socket interaction for boot stage local
152s Jul 08 18:38:00 autopkgtest systemd[1]: Finished cloud-init-local.service - Cloud-init: Local Stage (pre-network).
152s Jul 08 18:38:00 autopkgtest systemd[1]: Reached target network-pre.target - Preparation for Network.
152s Jul 08 18:38:00 autopkgtest systemd[1]: Starting cloud-init-network.service - Cloud-init: Network Stage...
152s Jul 08 18:38:00 autopkgtest systemd[1]: Starting systemd-networkd.service - Network Configuration...
152s Jul 08 18:38:00 autopkgtest kernel: cfg80211: Loading compiled-in X.509 certificates for regulatory database
152s Jul 08 18:38:00 autopkgtest kernel: Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'
152s Jul 08 18:38:00 autopkgtest kernel: Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'
152s Jul 08 18:38:00 autopkgtest kernel: platform regulatory.0: Direct firmware load for regulatory.db failed with error -2
152s Jul 08 18:38:00 autopkgtest kernel: cfg80211: failed to load regulatory.db
152s Jul 08 18:38:00 autopkgtest systemd-networkd[713]: /run/systemd/network/10-netplan-enp0s1.network: MTUBytes= in [Link] section and UseMTU= in [DHCP] section are set. Disabling UseMTU=.
152s Jul 08 18:38:00 autopkgtest systemd-networkd[713]: lo: Link UP
152s Jul 08 18:38:00 autopkgtest systemd-networkd[713]: lo: Gained carrier
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: Cloud-init v. 25.2~5g009c4cfd-0ubuntu1 running 'init' at Tue, 08 Jul 2025 18:38:00 +0000. Up 4.46 seconds.
152s Jul 08 18:38:00 autopkgtest systemd[1]: Started systemd-networkd.service - Network Configuration.
152s Jul 08 18:38:00 autopkgtest systemd[1]: Reached target network.target - Network.
152s Jul 08 18:38:00 autopkgtest systemd-networkd[713]: enp0s1: Configuring with /run/systemd/network/10-netplan-enp0s1.network.
152s Jul 08 18:38:00 autopkgtest systemd[1]: Starting systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd...
152s Jul 08 18:38:00 autopkgtest systemd-networkd[713]: enp0s1: Link UP
152s Jul 08 18:38:00 autopkgtest systemd-networkd[713]: enp0s1: Gained carrier
152s Jul 08 18:38:00 autopkgtest systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Configured...
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: ++++++++++++++++++++++++++++++++++++Net device info+++++++++++++++++++++++++++++++++++++
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: +--------+------+------------------------------+-----------+-------+-------------------+
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: | Device | Up | Address | Mask | Scope | Hw-Address |
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: +--------+------+------------------------------+-----------+-------+-------------------+
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: | enp0s1 | True | fe80::f816:3eff:fe37:4b53/64 | . | link | fa:16:3e:37:4b:53 |
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: | lo | True | 127.0.0.1 | 255.0.0.0 | host | . |
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: | lo | True | ::1/128 | . | host | . |
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: +--------+------+------------------------------+-----------+-------+-------------------+
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: +++++++++++++++++++Route IPv6 info+++++++++++++++++++
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: +-------+-------------+---------+-----------+-------+
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: | Route | Destination | Gateway | Interface | Flags |
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: +-------+-------------+---------+-----------+-------+
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: | 0 | fe80::/64 | :: | enp0s1 | U |
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: | 2 | multicast | :: | enp0s1 | U |
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: ci-info: +-------+-------------+---------+-----------+-------+
152s Jul 08 18:38:00 autopkgtest systemd-networkd[713]: enp0s1: DHCPv4 address 10.145.227.239/24, gateway 10.145.227.1 acquired from 10.145.227.1
152s Jul 08 18:38:00 autopkgtest systemd-timesyncd[330]: Network configuration changed, trying to establish connection.
152s Jul 08 18:38:00 autopkgtest systemd[1]: Finished systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd.
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: 2025-07-08 18:38:00,797 - loggers.py[DEPRECATED]: Deprecated cloud-config provided: apt_update: Deprecated in version 22.2. Use **package_update** instead., apt_upgrade: Deprecated in version 22.2. Use **package_upgrade** instead.
152s Jul 08 18:38:00 autopkgtest cloud-init[673]: 2025-07-08 18:38:00,797 - schema.py[WARNING]: cloud-config failed schema validation! You may run 'sudo cloud-init schema --system' to check the details.
152s Jul 08 18:38:00 autopkgtest sh[720]: Completed socket interaction for boot stage network
152s Jul 08 18:38:00 autopkgtest systemd[1]: Finished cloud-init-network.service - Cloud-init: Network Stage.
152s Jul 08 18:38:00 autopkgtest systemd[1]: Reached target cloud-config.target - Cloud-config availability.
152s Jul 08 18:38:00 autopkgtest systemd[1]: Listening on cloud-init-hotplugd.socket - cloud-init hotplug hook socket.
152s Jul 08 18:38:01 autopkgtest kernel: kauditd_printk_skb: 126 callbacks suppressed
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.172:137): apparmor="STATUS" operation="profile_load" profile="unconfined" name="ubuntu_pro_apt_news" pid=809 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.220:138): apparmor="STATUS" operation="profile_load" profile="unconfined" name="transmission-cli" pid=796 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.224:139): apparmor="STATUS" operation="profile_load" profile="unconfined" name="transmission-daemon" pid=796 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.224:140): apparmor="STATUS" operation="profile_load" profile="unconfined" name="transmission-gtk" pid=796 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.228:141): apparmor="STATUS" operation="profile_load" profile="unconfined" name="transmission-qt" pid=796 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.268:142): apparmor="STATUS" operation="profile_load" profile="unconfined" name="unix-chkpwd" pid=811 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.272:143): apparmor="STATUS" operation="profile_load" profile="unconfined" name="unprivileged_userns" pid=812 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.276:144): apparmor="STATUS" operation="profile_load" profile="unconfined" name="userbindmount" pid=813 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.324:145): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/bin/man" pid=814 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest kernel: audit: type=1400 audit(1751999881.324:146): apparmor="STATUS" operation="profile_load" profile="unconfined" name="man_filter" pid=814 comm="apparmor_parser"
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished apparmor.service - Load AppArmor profiles.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target sysinit.target - System Initialization.
152s Jul 08 18:38:01 autopkgtest systemd[1]: apport-autoreport.path - Process error reports when automatic reporting is enabled (file watch) was skipped because of an unmet condition check (ConditionPathExists=/var/lib/apport/autoreport).
152s Jul 08 18:38:01 autopkgtest systemd[1]: apport-autoreport.timer - Process error reports when automatic reporting is enabled (timer based) was skipped because of an unmet condition check (ConditionPathExists=/var/lib/apport/autoreport).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started apt-daily.timer - Daily apt download activities.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started apt-daily-upgrade.timer - Daily apt upgrade and clean activities.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started dpkg-db-backup.timer - Daily dpkg database backup timer.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started e2scrub_all.timer - Periodic ext4 Online Metadata Check for All Filesystems.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started fstrim.timer - Discard unused filesystem blocks once a week.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started fwupd-refresh.timer - Refresh fwupd metadata regularly.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started logrotate.timer - Daily rotation of log files.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started man-db.timer - Daily man-db regeneration.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started motd-news.timer - Message of the Day.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started sysstat-collect.timer - Run system activity accounting tool every 10 minutes.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started sysstat-rotate.timer - Rotate daily system activity data file at midnight.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started sysstat-summary.timer - Generate summary of yesterday's process accounting.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories.
152s Jul 08 18:38:01 autopkgtest systemd[1]: ua-timer.timer - Ubuntu Pro Timer for running repeated jobs was skipped because of an unmet condition check (ConditionPathExists=/var/lib/ubuntu-advantage/private/machine-token.json).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target boot-complete.target - Boot Completion Check.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target paths.target - Path Units.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target timers.target - Timer Units.
152s Jul 08 18:38:01 autopkgtest systemd[1]: apport-forward.socket - Unix socket for apport crash forwarding was skipped because of an unmet condition check (ConditionVirtualization=container).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting lxd-installer.socket - Helper to install lxd snap on demand...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Listening on ssh.socket - OpenBSD Secure Shell server socket.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Listening on sshd-unix-local.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_UNIX Local).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Listening on sshd-vsock.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_VSOCK).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target ssh-access.target - SSH Access Available.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Listening on systemd-hostnamed.socket - Hostname Service Socket.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Listening on uuidd.socket - UUID daemon activation socket.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Listening on lxd-installer.socket - Helper to install lxd snap on demand.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target sockets.target - Socket Units.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target basic.target - Basic System.
152s Jul 08 18:38:01 autopkgtest systemd[1]: System is tainted: unmerged-bin
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting apport.service - automatic crash report generation...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started autopkgtest@hvc1.service - autopkgtest root shell on hvc1.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started autopkgtest@ttyS1.service - autopkgtest root shell on ttyS1.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started cron.service - Regular background program processing daemon.
152s Jul 08 18:38:01 autopkgtest (sh)[833]: autopkgtest@hvc1.service: Failed to set up standard input: No such device
152s Jul 08 18:38:01 autopkgtest (sh)[833]: autopkgtest@hvc1.service: Failed at step STDIN spawning /bin/sh: No such device
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting dbus.service - D-Bus System Message Bus...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started dmesg.service - Save initial kernel messages after boot.
152s Jul 08 18:38:01 autopkgtest (cron)[835]: cron.service: Referenced but unset environment variable evaluates to an empty string: EXTRA_OPTS
152s Jul 08 18:38:01 autopkgtest cron[835]: (CRON) INFO (pidfile fd = 3)
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting e2scrub_reap.service - Remove Stale Online ext4 Metadata Check Snapshots...
152s Jul 08 18:38:01 autopkgtest systemd[1]: getty-static.service - getty on tty2-tty6 if dbus and logind are not available was skipped because of an unmet condition check (ConditionPathExists=!/usr/bin/dbus-daemon).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting grub-common.service - Record successful boot for GRUB...
152s Jul 08 18:38:01 autopkgtest cron[835]: (CRON) INFO (Running @reboot jobs)
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting iprdump.service - IBM Power Raid dump daemon...
152s Jul 08 18:38:01 autopkgtest systemd[1]: networkd-dispatcher.service - Dispatcher daemon for systemd-networkd was skipped because no trigger condition checks were met.
152s Jul 08 18:38:01 autopkgtest systemd[1]: opal_errd.service - opal_errd (PowerNV platform error handling) Service was skipped because of an unmet condition check (ConditionVirtualization=false).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting rng-tools-debian.service - Hardware RNG entropy gatherer daemon (Debian variant)...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting rsyslog.service - System Logging Service...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting rtas_errd.service - ppc64-diag rtas_errd (platform error handling) Service...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting sysstat.service - Resets System Activity Logs...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting systemd-logind.service - User Login Management...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions...
152s Jul 08 18:38:01 autopkgtest systemd[1]: ua-reboot-cmds.service - Ubuntu Pro reboot cmds was skipped because of an unmet condition check (ConditionPathExists=/var/lib/ubuntu-advantage/private/machine-token.json).
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting udisks2.service - Disk Manager...
152s Jul 08 18:38:01 autopkgtest systemd[1]: autopkgtest@hvc1.service: Deactivated successfully.
152s Jul 08 18:38:01 autopkgtest systemd[1]: autopkgtest@ttyS1.service: Deactivated successfully.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started iprdump.service - IBM Power Raid dump daemon.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting iprinit.service - IBM Power Raid init daemon...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting iprupdate.service - IBM Power Raid update daemon...
152s Jul 08 18:38:01 autopkgtest systemd[1]: e2scrub_reap.service: Deactivated successfully.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished e2scrub_reap.service - Remove Stale Online ext4 Metadata Check Snapshots.
152s Jul 08 18:38:01 autopkgtest udisksd[849]: udisks daemon version 2.10.1 starting
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished sysstat.service - Resets System Activity Logs.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started iprupdate.service - IBM Power Raid update daemon.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started iprinit.service - IBM Power Raid init daemon.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target iprutils.target - IBM Power Raid utilities.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting plymouth-quit-wait.service - Hold until boot process finishes up...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting plymouth-quit.service - Terminate Plymouth Boot Screen...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started rtas_errd.service - ppc64-diag rtas_errd (platform error handling) Service.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished plymouth-quit-wait.service - Hold until boot process finishes up.
152s Jul 08 18:38:01 autopkgtest dbus-daemon[836]: [system] AppArmor D-Bus mediation is enabled
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started serial-getty@hvc0.service - Serial Getty on hvc0.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting setvtrgb.service - Set console scheme...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started dbus.service - D-Bus System Message Bus.
152s Jul 08 18:38:01 autopkgtest systemd[1]: grub-common.service: Deactivated successfully.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished grub-common.service - Record successful boot for GRUB.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Starting grub-initrd-fallback.service - GRUB failed boot detection...
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished plymouth-quit.service - Terminate Plymouth Boot Screen.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished setvtrgb.service - Set console scheme.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Created slice system-getty.slice - Slice /system/getty.
152s Jul 08 18:38:01 autopkgtest rng-tools-debian[896]: not starting: /dev/hwrng is used by the kernel automatically
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started getty@tty1.service - Getty on tty1.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Reached target getty.target - Login Prompts.
152s Jul 08 18:38:01 autopkgtest systemd[1]: rng-tools-debian.service: Skipped due to 'exec-condition'.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Condition check resulted in rng-tools-debian.service - Hardware RNG entropy gatherer daemon (Debian variant) being skipped.
152s Jul 08 18:38:01 autopkgtest systemd[1]: grub-initrd-fallback.service: Deactivated successfully.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished grub-initrd-fallback.service - GRUB failed boot detection.
152s Jul 08 18:38:01 autopkgtest systemd-logind[847]: New seat seat0.
152s Jul 08 18:38:01 autopkgtest systemd-logind[847]: Watching system buttons on /dev/input/event0 (QEMU QEMU USB Keyboard)
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started systemd-logind.service - User Login Management.
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started udisks2.service - Disk Manager.
152s Jul 08 18:38:01 autopkgtest udisksd[849]: Acquired the name org.freedesktop.UDisks2 on the system message bus
152s Jul 08 18:38:01 autopkgtest systemd[1]: Finished apport.service - automatic crash report generation.
152s Jul 08 18:38:01 autopkgtest rsyslogd[911]: imuxsock: Acquired UNIX socket '/run/systemd/journal/syslog' (fd 3) from systemd. [v8.2412.0]
152s Jul 08 18:38:01 autopkgtest systemd[1]: Started rsyslog.service - System Logging Service.
152s Jul 08 18:38:01 autopkgtest rsyslogd[911]: rsyslogd's groupid changed to 102
152s Jul 08 18:38:01 autopkgtest rsyslogd[911]: rsyslogd's userid changed to 102
152s Jul 08 18:38:01 autopkgtest rsyslogd[911]: [origin software="rsyslogd" swVersion="8.2412.0" x-pid="911" x-info="https://www.rsyslog.com"] start
152s Jul 08 18:38:02 autopkgtest systemd-networkd[713]: enp0s1: Gained IPv6LL
152s Jul 08 18:38:02 autopkgtest systemd-timesyncd[330]: Network configuration changed, trying to establish connection.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Configured.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Reached target network-online.target - Network is Online.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Starting cloud-config.service - Cloud-init: Config Stage...
152s Jul 08 18:38:02 autopkgtest systemd[1]: pollinate.service - Pollinate to seed the pseudo random number generator was skipped because of an unmet condition check (ConditionPathExists=!/var/cache/pollinate/seeded).
152s Jul 08 18:38:02 autopkgtest systemd[1]: Starting ssh.service - OpenBSD Secure Shell server...
152s Jul 08 18:38:02 autopkgtest systemd[1]: ubuntu-advantage.service - Ubuntu Pro Background Auto Attach was skipped because no trigger condition checks were met.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Reached target multi-user.target - Multi-User System.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Reached target graphical.target - Graphical Interface.
152s Jul 08 18:38:02 autopkgtest sshd[926]: Server listening on 0.0.0.0 port 22.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Started ssh.service - OpenBSD Secure Shell server.
152s Jul 08 18:38:02 autopkgtest sshd[926]: Server listening on :: port 22.
152s Jul 08 18:38:02 autopkgtest cloud-init[673]: Cloud-init v. 25.2~5g009c4cfd-0ubuntu1 running 'modules:config' at Tue, 08 Jul 2025 18:38:02 +0000. Up 6.34 seconds.
152s Jul 08 18:38:02 autopkgtest sh[924]: Completed socket interaction for boot stage config
152s Jul 08 18:38:02 autopkgtest systemd[1]: Finished cloud-config.service - Cloud-init: Config Stage.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Starting cloud-final.service - Cloud-init: Final Stage...
152s Jul 08 18:38:02 autopkgtest cloud-init[673]: Cloud-init v. 25.2~5g009c4cfd-0ubuntu1 running 'modules:final' at Tue, 08 Jul 2025 18:38:02 +0000. Up 6.54 seconds.
152s Jul 08 18:38:02 autopkgtest cloud-init[673]: Cloud-init v. 25.2~5g009c4cfd-0ubuntu1 finished at Tue, 08 Jul 2025 18:38:02 +0000. Datasource DataSourceConfigDrive [net,ver=2][source=/dev/sr0]. Up 6.66 seconds
152s Jul 08 18:38:02 autopkgtest sh[934]: Completed socket interaction for boot stage final
152s Jul 08 18:38:02 autopkgtest systemd[1]: Finished cloud-final.service - Cloud-init: Final Stage.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Reached target cloud-init.target - Cloud-init target.
152s Jul 08 18:38:02 autopkgtest systemd[1]: Startup finished in 2.407s (kernel) + 4.276s (userspace) = 6.684s.
152s Jul 08 18:38:02 autopkgtest systemd[1]: cloud-init-main.service: Deactivated successfully.
152s Jul 08 18:38:02 autopkgtest systemd[1]: cloud-init-main.service: Consumed 1.242s CPU time, 108.5M memory peak.
152s Jul 08 18:38:03 autopkgtest kernel: fbcon: Taking over console
152s Jul 08 18:38:03 autopkgtest kernel: Console: switching to colour frame buffer device 128x48
152s Jul 08 18:38:03 autopkgtest systemd[1]: dmesg.service: Deactivated successfully.
152s Jul 08 18:38:03 autopkgtest sshd-session[928]: Accepted publickey for ubuntu from 10.136.6.184 port 39720 ssh2: RSA SHA256:h+sR5tlNZDfTFbz7cAH7wlRKfPAD8MpCdKJaoGeL2vg
152s Jul 08 18:38:03 autopkgtest sshd-session[928]: pam_unix(sshd:session): session opened for user ubuntu(uid=1000) by ubuntu(uid=0)
152s Jul 08 18:38:03 autopkgtest systemd-logind[847]: New session 1 of user ubuntu.
152s Jul 08 18:38:03 autopkgtest systemd[1]: Created slice user-1000.slice - User Slice of UID 1000.
152s Jul 08 18:38:03 autopkgtest systemd[1]: Starting user-runtime-dir@1000.service - User Runtime Directory /run/user/1000...
152s Jul 08 18:38:03 autopkgtest systemd[1]: Finished user-runtime-dir@1000.service - User Runtime Directory /run/user/1000.
152s Jul 08 18:38:03 autopkgtest systemd[1]: Starting user@1000.service - User Manager for UID 1000...
152s Jul 08 18:38:03 autopkgtest (systemd)[985]: pam_unix(systemd-user:session): session opened for user ubuntu(uid=1000) by ubuntu(uid=0)
152s Jul 08 18:38:03 autopkgtest systemd-logind[847]: New session 2 of user ubuntu.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Queued start job for default target default.target.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Created slice app.slice - User Application Slice.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Started launchpadlib-cache-clean.timer - Clean up old files in the Launchpadlib cache.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Reached target paths.target - Paths.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Reached target timers.target - Timers.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Starting dbus.socket - D-Bus User Message Bus Socket...
152s Jul 08 18:38:03 autopkgtest systemd[985]: Listening on dirmngr.socket - GnuPG network certificate management daemon.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Listening on gpg-agent-browser.socket - GnuPG cryptographic agent and passphrase cache (access for web browsers).
152s Jul 08 18:38:03 autopkgtest systemd[985]: Listening on gpg-agent-extra.socket - GnuPG cryptographic agent and passphrase cache (restricted).
152s Jul 08 18:38:03 autopkgtest systemd[985]: Starting gpg-agent-ssh.socket - GnuPG cryptographic agent (ssh-agent emulation)...
152s Jul 08 18:38:03 autopkgtest systemd[985]: Starting gpg-agent.socket - GnuPG cryptographic agent and passphrase cache...
152s Jul 08 18:38:03 autopkgtest systemd[985]: Listening on keyboxd.socket - GnuPG public key management service.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Listening on dbus.socket - D-Bus User Message Bus Socket.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Listening on gpg-agent.socket - GnuPG cryptographic agent and passphrase cache.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Listening on gpg-agent-ssh.socket - GnuPG cryptographic agent (ssh-agent emulation).
152s Jul 08 18:38:03 autopkgtest systemd[985]: Reached target sockets.target - Sockets.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Reached target basic.target - Basic System.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Reached target default.target - Main User Target.
152s Jul 08 18:38:03 autopkgtest systemd[1]: Started user@1000.service - User Manager for UID 1000.
152s Jul 08 18:38:03 autopkgtest systemd[985]: Startup finished in 119ms.
152s Jul 08 18:38:03 autopkgtest systemd[1]: Started session-1.scope - Session 1 of User ubuntu.
152s Jul 08 18:38:05 autopkgtest sudo[1031]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/bin/true
152s Jul 08 18:38:05 autopkgtest sudo[1031]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:05 autopkgtest sudo[1031]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:06 autopkgtest sudo[1036]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper /bin/sh -ec 'for d in /var/cache /home; do if [ -e $d/autopkgtest-tmpdir.tar ]; then /bin/tar --warning=none --extract --absolute-names -f $d/autopkgtest-tmpdir.tar; /bin/rm $d/autopkgtest-tmpdir.tar; exit 0; fi; done; exit 1'
152s Jul 08 18:38:06 autopkgtest sudo[1036]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:06 autopkgtest sudo[1036]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:06 autopkgtest sudo[1048]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper mkdir -p /tmp/autopkgtest.Fzjg4c
152s Jul 08 18:38:06 autopkgtest sudo[1048]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:06 autopkgtest sudo[1048]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:06 autopkgtest sudo[1058]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'cat >/tmp/autopkgtest.Fzjg4c/autopkgtest-reboot; chmod +x -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot'
152s Jul 08 18:38:06 autopkgtest sudo[1058]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:06 autopkgtest sudo[1058]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:06 autopkgtest sudo[1070]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper chmod -R 0755 -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot
152s Jul 08 18:38:06 autopkgtest sudo[1070]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:06 autopkgtest sudo[1070]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:06 autopkgtest sudo[1080]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper ln -fns /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot /tmp/autopkgtest-reboot
152s Jul 08 18:38:06 autopkgtest sudo[1080]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:06 autopkgtest sudo[1080]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:07 autopkgtest sudo[1092]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper ln -fns /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot /sbin/autopkgtest-reboot
152s Jul 08 18:38:07 autopkgtest sudo[1092]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:07 autopkgtest sudo[1092]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:07 autopkgtest sudo[1102]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper mkdir -p /tmp/autopkgtest.Fzjg4c
152s Jul 08 18:38:07 autopkgtest sudo[1102]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:07 autopkgtest sudo[1102]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:07 autopkgtest sudo[1112]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'cat >/tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare; chmod +x -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare'
152s Jul 08 18:38:07 autopkgtest sudo[1112]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:07 autopkgtest sudo[1112]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:07 autopkgtest sudo[1124]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper chmod -R 0755 -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare
152s Jul 08 18:38:07 autopkgtest sudo[1124]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:07 autopkgtest sudo[1124]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:07 autopkgtest sudo[1134]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper ln -fns /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare /tmp/autopkgtest-reboot-prepare
152s Jul 08 18:38:07 autopkgtest sudo[1134]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:07 autopkgtest sudo[1134]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:08 autopkgtest sudo[1144]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper uname -srv
152s Jul 08 18:38:08 autopkgtest sudo[1144]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:08 autopkgtest sudo[1144]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:08 autopkgtest sudo[1154]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -c 'nproc; cat /proc/cpuinfo 2>/dev/null || true'
152s Jul 08 18:38:08 autopkgtest sudo[1154]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:08 autopkgtest sudo[1154]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:08 autopkgtest sudo[1166]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'dpkg-query --show -f \'${Package}\\t${Version}\\n\' > /tmp/autopkgtest.Fzjg4c/testbed-packages'
152s Jul 08 18:38:08 autopkgtest sudo[1166]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:08 autopkgtest sudo[1166]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:08 autopkgtest sudo[1177]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'cat /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot; chmod +x -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot'
152s Jul 08 18:38:08 autopkgtest sudo[1198]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:09 autopkgtest sudo[1198]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:09 autopkgtest sudo[1210]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper chmod -R 0755 -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot
152s Jul 08 18:38:09 autopkgtest sudo[1210]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:09 autopkgtest sudo[1210]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:09 autopkgtest sudo[1220]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper ln -fns /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot /tmp/autopkgtest-reboot
152s Jul 08 18:38:09 autopkgtest sudo[1220]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:09 autopkgtest sudo[1220]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:09 autopkgtest sudo[1230]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper ln -fns /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot /sbin/autopkgtest-reboot
152s Jul 08 18:38:09 autopkgtest sudo[1230]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:09 autopkgtest sudo[1230]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:09 autopkgtest sudo[1240]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper mkdir -p /tmp/autopkgtest.Fzjg4c
152s Jul 08 18:38:09 autopkgtest sudo[1240]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:09 autopkgtest sudo[1240]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:10 autopkgtest sudo[1250]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'cat >/tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare; chmod +x -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare'
152s Jul 08 18:38:10 autopkgtest sudo[1250]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:10 autopkgtest sudo[1250]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:10 autopkgtest sudo[1262]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper chmod -R 0755 -- /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare
152s Jul 08 18:38:10 autopkgtest sudo[1262]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:10 autopkgtest sudo[1262]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:10 autopkgtest sudo[1274]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper ln -fns /tmp/autopkgtest.Fzjg4c/autopkgtest-reboot-prepare /tmp/autopkgtest-reboot-prepare
152s Jul 08 18:38:10 autopkgtest sudo[1274]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:10 autopkgtest sudo[1274]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:10 autopkgtest sudo[1284]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper uname -srv
152s Jul 08 18:38:10 autopkgtest sudo[1284]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:10 autopkgtest sudo[1284]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:10 autopkgtest sudo[1294]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper apt-cache showsrc --only-source cockpit-podman
152s Jul 08 18:38:10 autopkgtest sudo[1294]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:11 autopkgtest sudo[1294]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:11 autopkgtest sudo[1305]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper apt-cache policy ^cockpit-podman$
152s Jul 08 18:38:11 autopkgtest sudo[1305]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:11 autopkgtest sudo[1305]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:11 autopkgtest sudo[1317]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper apt-cache show cockpit-podman=108-1
152s Jul 08 18:38:11 autopkgtest sudo[1317]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:11 autopkgtest sudo[1317]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:12 autopkgtest sudo[1329]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'command -v dpkg-source'
152s Jul 08 18:38:12 autopkgtest sudo[1329]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:12 autopkgtest sudo[1329]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:12 autopkgtest sudo[1339]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper env ADT_TEST_TRIGGERS=podman/5.4.2+ds1-2 sh -ec 'su --shell=/bin/sh ubuntu -c \'set -e; exec 3>&1 >&2; cd /; builddir=$(mktemp -d /tmp/autopkgtest.Fzjg4c/build.XXX); cd $builddir; OUT=$(apt-get source -d -q --only-source cockpit-podman=108-1 2>&1) || RC=$?;if [ -n "$RC" ]; then if echo "$OUT" | grep -q "Unable to find a source package"; then exit 1; else exit $RC; fi;fi;echo "$OUT" | grep ^Get: || true;dpkg-source -x cockpit-podman_*.dsc src >/dev/null; chmod -R a+rX .; cd [a-z0-9]*/.; pwd >&3; sed -n "1 {s/).*//; s/ (/\\n/; p}" debian/changelog >&3\''
152s Jul 08 18:38:12 autopkgtest sudo[1339]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:12 autopkgtest su[1343]: (to ubuntu) root on none
152s Jul 08 18:38:12 autopkgtest su[1343]: pam_unix(su:session): session opened for user ubuntu(uid=1000) by ubuntu(uid=0)
152s Jul 08 18:38:14 autopkgtest su[1343]: pam_unix(su:session): session closed for user ubuntu
152s Jul 08 18:38:14 autopkgtest sudo[1339]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:14 autopkgtest sudo[1376]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'cd /tmp/autopkgtest.Fzjg4c/build.WH7/src/debian/; tar --warning=none -c . -f -'
152s Jul 08 18:38:14 autopkgtest sudo[1376]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:14 autopkgtest sudo[1376]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:14 autopkgtest sudo[1387]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'cd /tmp/autopkgtest.Fzjg4c/build.WH7/src/; tar --warning=none -c . -f -'
152s Jul 08 18:38:14 autopkgtest sudo[1387]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:15 autopkgtest sudo[1387]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:15 autopkgtest sudo[1398]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper env DEBIAN_FRONTEND=noninteractive APT_LISTBUGS_FRONTEND=none APT_LISTCHANGES_FRONTEND=none /bin/sh -ec '"$@" 3>&2 2>&1' run_apt_command /usr/bin/eatmydata apt-get --quiet --assume-yes -o=APT::Status-Fd=3 -o=APT::Install-Recommends=false -o=Dpkg::Options::=--force-confnew -o=Debug::pkgProblemResolver=true satisfy 'cockpit-podman, cockpit-ws, curl, adduser'
152s Jul 08 18:38:15 autopkgtest sudo[1398]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:31 autopkgtest systemd-resolved[328]: Clock change detected. Flushing caches.
152s Jul 08 18:38:31 autopkgtest systemd-timesyncd[330]: Contacted time server 91.189.91.157:123 (ntp.ubuntu.com).
152s Jul 08 18:38:31 autopkgtest systemd-timesyncd[330]: Initial clock synchronization to Tue 2025-07-08 18:38:31.823511 UTC.
152s Jul 08 18:38:34 autopkgtest systemd[1]: Reload requested from client PID 1638 ('systemctl') (unit session-1.scope)...
152s Jul 08 18:38:34 autopkgtest systemd[1]: Reloading...
152s Jul 08 18:38:35 autopkgtest systemd[1]: Reloading finished in 206 ms.
152s Jul 08 18:38:35 autopkgtest systemd[1]: Listening on netavark-dhcp-proxy.socket - Netavark DHCP proxy socket.
152s Jul 08 18:38:35 autopkgtest systemd[1]: Starting netavark-dhcp-proxy.service - Netavark DHCP proxy service...
152s Jul 08 18:38:35 autopkgtest systemd[1]: Started netavark-firewalld-reload.service - Listen for the firewalld reload event and reapply all netavark firewall rules..
152s Jul 08 18:38:35 autopkgtest systemd[1]: Started netavark-dhcp-proxy.service - Netavark DHCP proxy service.
152s Jul 08 18:38:38 autopkgtest systemd[1]: Reload requested from client PID 1758 ('systemctl') (unit session-1.scope)...
152s Jul 08 18:38:38 autopkgtest systemd[1]: Reloading...
152s Jul 08 18:38:38 autopkgtest systemd[1]: Reloading finished in 200 ms.
152s Jul 08 18:38:38 autopkgtest systemd[1]: Starting cockpit.socket - Cockpit Web Service Socket...
152s Jul 08 18:38:38 autopkgtest systemd[1]: Listening on cockpit.socket - Cockpit Web Service Socket.
152s Jul 08 18:38:38 autopkgtest systemd[1]: Starting cockpit-issue.service - Cockpit issue updater service...
152s Jul 08 18:38:38 autopkgtest kernel: kauditd_printk_skb: 27 callbacks suppressed
152s Jul 08 18:38:38 autopkgtest kernel: audit: type=1400 audit(1751999918.475:174): apparmor="STATUS" operation="profile_load" profile="unconfined" name="cockpit-desktop" pid=1830 comm="apparmor_parser"
152s Jul 08 18:38:38 autopkgtest systemd[1]: cockpit-issue.service: Deactivated successfully.
152s Jul 08 18:38:38 autopkgtest systemd[1]: Finished cockpit-issue.service - Cockpit issue updater service.
152s Jul 08 18:38:38 autopkgtest sudo[1398]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:38 autopkgtest sudo[1853]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper dpkg-query --show -f ${Status} cockpit-podman
152s Jul 08 18:38:38 autopkgtest sudo[1853]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:38 autopkgtest sudo[1853]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:39 autopkgtest sudo[1863]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'dpkg-query --show -f \'${Package}\\t${Version}\\n\' > /tmp/autopkgtest.Fzjg4c/smoke-packages.all'
152s Jul 08 18:38:39 autopkgtest sudo[1863]: pam_unix(sudo:session): session opened for user root(uid=0) by ubuntu(uid=1000)
152s Jul 08 18:38:39 autopkgtest sudo[1863]: pam_unix(sudo:session): session closed for user root
152s Jul 08 18:38:39 autopkgtest sudo[1874]: ubuntu : PWD=/home/ubuntu ; USER=root ; COMMAND=/tmp/autopkgtest-run-wrapper sh -ec 'cat