0s autopkgtest [19:57:36]: starting date and time: 2025-11-19 19:57:36+0000 0s autopkgtest [19:57:36]: git checkout: 4b346b80 nova: make wait_reboot return success even when a no-op 0s autopkgtest [19:57:36]: host juju-7f2275-prod-proposed-migration-environment-2; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.fx7gh868/out --timeout-copy=6000 --setup-commands /home/ubuntu/autopkgtest-cloud/worker-config-production/setup-canonical.sh --apt-pocket=proposed=src:systemd,src:dhcpcd --apt-upgrade gpsd --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 '--env=ADT_TEST_TRIGGERS=systemd/259~rc1-1ubuntu1 dhcpcd/1:10.3.0-1' -- ssh -s /home/ubuntu/autopkgtest/ssh-setup/nova -- --flavor autopkgtest-s390x --security-groups autopkgtest-juju-7f2275-prod-proposed-migration-environment-2@bos03-s390x-1.secgroup --name adt-resolute-s390x-gpsd-20251119-195735-juju-7f2275-prod-proposed-migration-environment-2-e027cfb9-1ce0-4971-aaf1-3fdda958b0b8 --image adt/ubuntu-resolute-s390x-server --keyname testbed-juju-7f2275-prod-proposed-migration-environment-2 --net-id=net_prod-proposed-migration-s390x -e TERM=linux --mirror=http://ftpmaster.internal/ubuntu/ 4s Creating nova instance adt-resolute-s390x-gpsd-20251119-195735-juju-7f2275-prod-proposed-migration-environment-2-e027cfb9-1ce0-4971-aaf1-3fdda958b0b8 from image adt/ubuntu-resolute-s390x-server-20251119.img (UUID 4c8db693-79bc-4b39-96fd-37c94e575c4f)... 49s autopkgtest [19:58:25]: testbed dpkg architecture: s390x 49s autopkgtest [19:58:25]: testbed apt version: 3.1.12 49s autopkgtest [19:58:25]: @@@@@@@@@@@@@@@@@@@@ test bed setup 49s autopkgtest [19:58:25]: testbed release detected to be: None 50s autopkgtest [19:58:26]: updating testbed package index (apt update) 50s Get:1 http://ftpmaster.internal/ubuntu resolute-proposed InRelease [87.8 kB] 51s Hit:2 http://ftpmaster.internal/ubuntu resolute InRelease 51s Hit:3 http://ftpmaster.internal/ubuntu resolute-updates InRelease 51s Hit:4 http://ftpmaster.internal/ubuntu resolute-security InRelease 51s Get:5 http://ftpmaster.internal/ubuntu resolute-proposed/multiverse Sources [21.4 kB] 51s Get:6 http://ftpmaster.internal/ubuntu resolute-proposed/restricted Sources [9848 B] 51s Get:7 http://ftpmaster.internal/ubuntu resolute-proposed/main Sources [67.2 kB] 51s Get:8 http://ftpmaster.internal/ubuntu resolute-proposed/universe Sources [804 kB] 51s Get:9 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x Packages [126 kB] 52s Get:10 http://ftpmaster.internal/ubuntu resolute-proposed/restricted s390x Packages [1276 B] 52s Get:11 http://ftpmaster.internal/ubuntu resolute-proposed/universe s390x Packages [457 kB] 52s Get:12 http://ftpmaster.internal/ubuntu resolute-proposed/multiverse s390x Packages [6220 B] 52s Fetched 1580 kB in 1s (1159 kB/s) 52s Reading package lists... 53s Hit:1 http://ftpmaster.internal/ubuntu resolute-proposed InRelease 53s Hit:2 http://ftpmaster.internal/ubuntu resolute InRelease 53s Hit:3 http://ftpmaster.internal/ubuntu resolute-updates InRelease 53s Hit:4 http://ftpmaster.internal/ubuntu resolute-security InRelease 54s Reading package lists... 54s Reading package lists... 54s Building dependency tree... 54s Reading state information... 54s Calculating upgrade... 54s The following packages will be upgraded: 54s dhcpcd-base libnss-systemd libpam-systemd libsystemd-shared libsystemd0 54s libudev1 libxml2-16 systemd systemd-cryptsetup systemd-resolved systemd-sysv 54s udev 55s 12 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 55s Need to get 9626 kB of archives. 55s After this operation, 1477 kB of additional disk space will be used. 55s Get:1 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x libsystemd0 s390x 259~rc1-1ubuntu1 [549 kB] 55s Get:2 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x systemd-sysv s390x 259~rc1-1ubuntu1 [9256 B] 55s Get:3 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x systemd-resolved s390x 259~rc1-1ubuntu1 [297 kB] 55s Get:4 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x libnss-systemd s390x 259~rc1-1ubuntu1 [188 kB] 55s Get:5 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x libpam-systemd s390x 259~rc1-1ubuntu1 [276 kB] 55s Get:6 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x libsystemd-shared s390x 259~rc1-1ubuntu1 [2519 kB] 56s Get:7 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x systemd s390x 259~rc1-1ubuntu1 [3126 kB] 57s Get:8 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x systemd-cryptsetup s390x 259~rc1-1ubuntu1 [127 kB] 57s Get:9 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x udev s390x 259~rc1-1ubuntu1 [1480 kB] 57s Get:10 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x libudev1 s390x 259~rc1-1ubuntu1 [214 kB] 57s Get:11 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x dhcpcd-base s390x 1:10.3.0-1 [225 kB] 57s Get:12 http://ftpmaster.internal/ubuntu resolute/main s390x libxml2-16 s390x 2.15.1+dfsg-0.4 [616 kB] 57s dpkg-preconfigure: unable to re-open stdin: No such file or directory 57s Fetched 9626 kB in 3s (3516 kB/s) 58s (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 ... 61309 files and directories currently installed.) 58s Preparing to unpack .../libsystemd0_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking libsystemd0:s390x (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Setting up libsystemd0:s390x (259~rc1-1ubuntu1) ... 58s (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 ... 61309 files and directories currently installed.) 58s Preparing to unpack .../systemd-sysv_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking systemd-sysv (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Preparing to unpack .../systemd-resolved_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking systemd-resolved (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Preparing to unpack .../libnss-systemd_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking libnss-systemd:s390x (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Preparing to unpack .../libpam-systemd_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking libpam-systemd:s390x (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Preparing to unpack .../libsystemd-shared_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking libsystemd-shared:s390x (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Setting up libsystemd-shared:s390x (259~rc1-1ubuntu1) ... 58s (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 ... 61308 files and directories currently installed.) 58s Preparing to unpack .../systemd_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking systemd (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Preparing to unpack .../systemd-cryptsetup_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking systemd-cryptsetup (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Preparing to unpack .../udev_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking udev (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Preparing to unpack .../libudev1_259~rc1-1ubuntu1_s390x.deb ... 58s Unpacking libudev1:s390x (259~rc1-1ubuntu1) over (257.9-0ubuntu2) ... 58s Setting up libudev1:s390x (259~rc1-1ubuntu1) ... 58s (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 ... 61373 files and directories currently installed.) 58s Preparing to unpack .../dhcpcd-base_1%3a10.3.0-1_s390x.deb ... 58s Unpacking dhcpcd-base (1:10.3.0-1) over (1:10.2.4-4) ... 58s Preparing to unpack .../libxml2-16_2.15.1+dfsg-0.4_s390x.deb ... 58s Unpacking libxml2-16:s390x (2.15.1+dfsg-0.4) over (2.15.1+dfsg-0.3) ... 58s Setting up libxml2-16:s390x (2.15.1+dfsg-0.4) ... 58s Setting up systemd (259~rc1-1ubuntu1) ... 58s Installing new version of config file /etc/systemd/journald.conf ... 58s Installing new version of config file /etc/systemd/logind.conf ... 58s Installing new version of config file /etc/systemd/networkd.conf ... 58s Installing new version of config file /etc/systemd/system.conf ... 59s Installing new version of config file /etc/systemd/user.conf ... 59s /usr/lib/tmpfiles.d/legacy.conf:14: Duplicate line for path "/run/lock", ignoring. 59s /usr/lib/tmpfiles.d/legacy.conf:14: Duplicate line for path "/run/lock", ignoring. 59s Setting up systemd-cryptsetup (259~rc1-1ubuntu1) ... 59s Setting up udev (259~rc1-1ubuntu1) ... 60s Setting up dhcpcd-base (1:10.3.0-1) ... 60s Installing new version of config file /etc/dhcpcd.conf ... 60s Creating group 'dhcpcd' with GID 986. 60s Setting up systemd-resolved (259~rc1-1ubuntu1) ... 60s Installing new version of config file /etc/systemd/resolved.conf ... 60s Created symlink '/etc/systemd/system/sockets.target.wants/systemd-resolved-monitor.socket' → '/usr/lib/systemd/system/systemd-resolved-monitor.socket'. 61s Created symlink '/etc/systemd/system/sockets.target.wants/systemd-resolved-varlink.socket' → '/usr/lib/systemd/system/systemd-resolved-varlink.socket'. 61s Could not execute systemctl: at /usr/bin/deb-systemd-invoke line 148. 61s Setting up systemd-sysv (259~rc1-1ubuntu1) ... 61s Setting up libnss-systemd:s390x (259~rc1-1ubuntu1) ... 61s Setting up libpam-systemd:s390x (259~rc1-1ubuntu1) ... 61s Processing triggers for libc-bin (2.42-2ubuntu2) ... 61s Processing triggers for man-db (2.13.1-1) ... 62s Processing triggers for dbus (1.16.2-2ubuntu2) ... 62s Processing triggers for shared-mime-info (2.4-5build2) ... 64s Processing triggers for procps (2:4.0.4-8ubuntu3) ... 64s Processing triggers for initramfs-tools (0.150ubuntu5) ... 64s update-initramfs: Generating /boot/initrd.img-6.17.0-5-generic 67s Using config file '/etc/zipl.conf' 67s Building bootmap in '/boot' 67s Adding IPL section 'ubuntu' (default) 67s Preparing boot device for LD-IPL: vda (0000). 67s Done. 67s autopkgtest [19:58:43]: upgrading testbed (apt dist-upgrade and autopurge) 67s Reading package lists... 68s Building dependency tree... 68s Reading state information... 68s Calculating upgrade... 68s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 68s Reading package lists... 68s Building dependency tree... 68s Reading state information... 68s Solving dependencies... 68s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 69s autopkgtest [19:58:45]: rebooting testbed after setup commands that affected boot 85s autopkgtest [19:59:01]: testbed running kernel: Linux 6.17.0-5-generic #5-Ubuntu SMP Mon Sep 22 08:56:47 UTC 2025 88s autopkgtest [19:59:04]: @@@@@@@@@@@@@@@@@@@@ apt-source gpsd 94s Get:1 http://ftpmaster.internal/ubuntu resolute/main gpsd 3.25-5ubuntu1 (dsc) [3183 B] 94s Get:2 http://ftpmaster.internal/ubuntu resolute/main gpsd 3.25-5ubuntu1 (tar) [5225 kB] 94s Get:3 http://ftpmaster.internal/ubuntu resolute/main gpsd 3.25-5ubuntu1 (asc) [833 B] 94s Get:4 http://ftpmaster.internal/ubuntu resolute/main gpsd 3.25-5ubuntu1 (diff) [53.2 kB] 94s gpgv: Signature made Wed Feb 12 00:48:31 2025 UTC 94s gpgv: using RSA key 5C7ABEA20F8630459CC8C8B5E27F2CF8458C2FA4 94s gpgv: Can't check signature: No public key 94s dpkg-source: warning: cannot verify inline signature for ./gpsd_3.25-5ubuntu1.dsc: no acceptable signature found 95s autopkgtest [19:59:11]: testing package gpsd version 3.25-5ubuntu1 96s autopkgtest [19:59:12]: build not needed 100s autopkgtest [19:59:16]: test check-service: preparing testbed 100s Reading package lists... 100s Building dependency tree... 100s Reading state information... 100s Solving dependencies... 100s The following NEW packages will be installed: 100s gpsd libbluetooth3 libgps30t64 100s 0 upgraded, 3 newly installed, 0 to remove and 0 not upgraded. 100s Need to get 595 kB of archives. 100s After this operation, 1990 kB of additional disk space will be used. 100s Get:1 http://ftpmaster.internal/ubuntu resolute/main s390x libgps30t64 s390x 3.25-5ubuntu1 [69.9 kB] 101s Get:2 http://ftpmaster.internal/ubuntu resolute/main s390x libbluetooth3 s390x 5.84-1 [77.1 kB] 101s Get:3 http://ftpmaster.internal/ubuntu resolute/main s390x gpsd s390x 3.25-5ubuntu1 [448 kB] 101s Fetched 595 kB in 1s (962 kB/s) 101s Selecting previously unselected package libgps30t64:s390x. 101s (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 ... 61374 files and directories currently installed.) 101s Preparing to unpack .../libgps30t64_3.25-5ubuntu1_s390x.deb ... 101s Unpacking libgps30t64:s390x (3.25-5ubuntu1) ... 101s Selecting previously unselected package libbluetooth3:s390x. 101s Preparing to unpack .../libbluetooth3_5.84-1_s390x.deb ... 101s Unpacking libbluetooth3:s390x (5.84-1) ... 101s Selecting previously unselected package gpsd. 101s Preparing to unpack .../gpsd_3.25-5ubuntu1_s390x.deb ... 101s Unpacking gpsd (3.25-5ubuntu1) ... 101s Setting up libgps30t64:s390x (3.25-5ubuntu1) ... 101s Setting up libbluetooth3:s390x (5.84-1) ... 101s Setting up gpsd (3.25-5ubuntu1) ... 101s Creating/updating gpsd user account... 102s Created symlink '/etc/systemd/system/sockets.target.wants/gpsd.socket' → '/usr/lib/systemd/system/gpsd.socket'. 103s gpsd.service is a disabled or a static unit, not starting it. 103s Processing triggers for man-db (2.13.1-1) ... 103s Processing triggers for libc-bin (2.42-2ubuntu2) ... 104s autopkgtest [19:59:20]: test check-service: [----------------------- 105s Check socket being active 105s enabled 105s active 105s Check service being inactive 105s inactive 105s disabled 105s Trying ::1... 105s Connected to localhost. 105s Escape character is '^]'. 105s {"class":"VERSION","release":"3.25","rev":"3.25","proto_major":3,"proto_minor":15} 115s {"class":"DEVICES","devices":[]} 115s {"class":"WATCH","enable":true,"json":true,"nmea":false,"raw":0,"scaled":false,"timing":false,"split24":false,"pps":false} 125s {"class":"DEVICES","devices":[]} 125s {"class":"WATCH","enable":false,"json":true,"nmea":false,"raw":0,"scaled":false,"timing":false,"split24":false,"pps":false} 135s simplify test debug - full log 135s Trying ::1... 135s Connected to localhost. 135s Escape character is '^]'. 135s {"class":"VERSION","release":"3.25","rev":"3.25","proto_major":3,"proto_minor":15} 135s {"class":"DEVICES","devices":[]} 135s {"class":"WATCH","enable":true,"json":true,"nmea":false,"raw":0,"scaled":false,"timing":false,"split24":false,"pps":false} 135s {"class":"DEVICES","devices":[]} 135s {"class":"WATCH","enable":false,"json":true,"nmea":false,"raw":0,"scaled":false,"timing":false,"split24":false,"pps":false} 135s Check log for version 135s {"class":"VERSION","release":"3.25","rev":"3.25","proto_major":3,"proto_minor":15} 135s Check log for devices 135s {"class":"DEVICES","devices":[]} 135s {"class":"DEVICES","devices":[]} 135s Check log for enabled watch 135s {"class":"WATCH","enable":true,"json":true,"nmea":false,"raw":0,"scaled":false,"timing":false,"split24":false,"pps":false} 135s Check log for disabled watch 135s {"class":"WATCH","enable":false,"json":true,"nmea":false,"raw":0,"scaled":false,"timing":false,"split24":false,"pps":false} 135s Check service being active now 135s active 135s autopkgtest [19:59:51]: test check-service: -----------------------] 135s check-service PASS 135s autopkgtest [19:59:51]: test check-service: - - - - - - - - - - results - - - - - - - - - - 136s autopkgtest [19:59:52]: @@@@@@@@@@@@@@@@@@@@ summary 136s check-service PASS