0s autopkgtest [11:44:09]: starting date and time: 2024-11-13 11:44:09+0000 0s autopkgtest [11:44:09]: git checkout: 0acbae0a WIP show VirtSubproc stderr in real-time 0s autopkgtest [11:44:09]: host juju-7f2275-prod-proposed-migration-environment-2; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.nsz2fbhb/out --timeout-copy=6000 --setup-commands /home/ubuntu/autopkgtest-cloud/worker-config-production/setup-canonical.sh --apt-pocket=proposed=src:python3-defaults,src:python3-stdlib-extensions --apt-upgrade libpff --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 '--env=ADT_TEST_TRIGGERS=python3-defaults/3.12.7-1 python3-stdlib-extensions/3.12.7-1' -- ssh -s /home/ubuntu/autopkgtest/ssh-setup/nova -- --flavor autopkgtest-s390x --security-groups autopkgtest-juju-7f2275-prod-proposed-migration-environment-2@bos03-s390x-19.secgroup --name adt-plucky-s390x-libpff-20241113-114408-juju-7f2275-prod-proposed-migration-environment-2-7474d364-bb38-44e6-b9c3-4bab54543cc9 --image adt/ubuntu-plucky-s390x-server --keyname testbed-juju-7f2275-prod-proposed-migration-environment-2 --net-id=net_prod-proposed-migration-s390x -e TERM=linux -e ''"'"'http_proxy=http://squid.internal:3128'"'"'' -e ''"'"'https_proxy=http://squid.internal:3128'"'"'' -e ''"'"'no_proxy=127.0.0.1,127.0.1.1,login.ubuntu.com,localhost,localdomain,novalocal,internal,archive.ubuntu.com,ports.ubuntu.com,security.ubuntu.com,ddebs.ubuntu.com,changelogs.ubuntu.com,keyserver.ubuntu.com,launchpadlibrarian.net,launchpadcontent.net,launchpad.net,10.24.0.0/24,keystone.ps5.canonical.com,objectstorage.prodstack5.canonical.com'"'"'' --mirror=http://ftpmaster.internal/ubuntu/ 107s autopkgtest [11:45:56]: testbed dpkg architecture: s390x 107s autopkgtest [11:45:56]: testbed apt version: 2.9.8 107s autopkgtest [11:45:56]: @@@@@@@@@@@@@@@@@@@@ test bed setup 108s Get:1 http://ftpmaster.internal/ubuntu plucky-proposed InRelease [73.9 kB] 108s Get:2 http://ftpmaster.internal/ubuntu plucky-proposed/main Sources [76.4 kB] 108s Get:3 http://ftpmaster.internal/ubuntu plucky-proposed/universe Sources [849 kB] 108s Get:4 http://ftpmaster.internal/ubuntu plucky-proposed/restricted Sources [7016 B] 108s Get:5 http://ftpmaster.internal/ubuntu plucky-proposed/multiverse Sources [15.3 kB] 108s Get:6 http://ftpmaster.internal/ubuntu plucky-proposed/main s390x Packages [85.8 kB] 108s Get:7 http://ftpmaster.internal/ubuntu plucky-proposed/universe s390x Packages [565 kB] 108s Get:8 http://ftpmaster.internal/ubuntu plucky-proposed/multiverse s390x Packages [16.6 kB] 108s Fetched 1689 kB in 1s (2305 kB/s) 109s Reading package lists... 111s Reading package lists... 111s Building dependency tree... 111s Reading state information... 111s Calculating upgrade... 111s The following NEW packages will be installed: 111s python3.13-gdbm 111s The following packages will be upgraded: 111s libgpgme11t64 libpython3-stdlib python3 python3-gdbm python3-minimal 111s 5 upgraded, 1 newly installed, 0 to remove and 0 not upgraded. 111s Need to get 252 kB of archives. 111s After this operation, 98.3 kB of additional disk space will be used. 111s Get:1 http://ftpmaster.internal/ubuntu plucky-proposed/main s390x python3-minimal s390x 3.12.7-1 [27.4 kB] 111s Get:2 http://ftpmaster.internal/ubuntu plucky-proposed/main s390x python3 s390x 3.12.7-1 [24.0 kB] 111s Get:3 http://ftpmaster.internal/ubuntu plucky-proposed/main s390x libpython3-stdlib s390x 3.12.7-1 [10.0 kB] 111s Get:4 http://ftpmaster.internal/ubuntu plucky/main s390x python3.13-gdbm s390x 3.13.0-2 [31.0 kB] 111s Get:5 http://ftpmaster.internal/ubuntu plucky-proposed/main s390x python3-gdbm s390x 3.12.7-1 [8642 B] 111s Get:6 http://ftpmaster.internal/ubuntu plucky/main s390x libgpgme11t64 s390x 1.23.2-5ubuntu4 [151 kB] 112s Fetched 252 kB in 0s (552 kB/s) 112s (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 ... 55510 files and directories currently installed.) 112s Preparing to unpack .../python3-minimal_3.12.7-1_s390x.deb ... 112s Unpacking python3-minimal (3.12.7-1) over (3.12.6-0ubuntu1) ... 112s Setting up python3-minimal (3.12.7-1) ... 112s (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 ... 55510 files and directories currently installed.) 112s Preparing to unpack .../python3_3.12.7-1_s390x.deb ... 112s Unpacking python3 (3.12.7-1) over (3.12.6-0ubuntu1) ... 112s Preparing to unpack .../libpython3-stdlib_3.12.7-1_s390x.deb ... 112s Unpacking libpython3-stdlib:s390x (3.12.7-1) over (3.12.6-0ubuntu1) ... 112s Selecting previously unselected package python3.13-gdbm. 112s Preparing to unpack .../python3.13-gdbm_3.13.0-2_s390x.deb ... 112s Unpacking python3.13-gdbm (3.13.0-2) ... 112s Preparing to unpack .../python3-gdbm_3.12.7-1_s390x.deb ... 112s Unpacking python3-gdbm:s390x (3.12.7-1) over (3.12.6-1ubuntu1) ... 112s Preparing to unpack .../libgpgme11t64_1.23.2-5ubuntu4_s390x.deb ... 112s Unpacking libgpgme11t64:s390x (1.23.2-5ubuntu4) over (1.18.0-4.1ubuntu4) ... 112s Setting up libgpgme11t64:s390x (1.23.2-5ubuntu4) ... 112s Setting up python3.13-gdbm (3.13.0-2) ... 112s Setting up libpython3-stdlib:s390x (3.12.7-1) ... 112s Setting up python3 (3.12.7-1) ... 112s Setting up python3-gdbm:s390x (3.12.7-1) ... 112s Processing triggers for man-db (2.12.1-3) ... 113s Processing triggers for libc-bin (2.40-1ubuntu3) ... 113s Reading package lists... 113s Building dependency tree... 113s Reading state information... 113s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 114s Hit:1 http://ftpmaster.internal/ubuntu plucky-proposed InRelease 114s Hit:2 http://ftpmaster.internal/ubuntu plucky InRelease 114s Hit:3 http://ftpmaster.internal/ubuntu plucky-updates InRelease 114s Hit:4 http://ftpmaster.internal/ubuntu plucky-security InRelease 114s Reading package lists... 115s Reading package lists... 115s Building dependency tree... 115s Reading state information... 115s Calculating upgrade... 115s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 115s Reading package lists... 115s Building dependency tree... 115s Reading state information... 115s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 118s autopkgtest [11:46:07]: testbed running kernel: Linux 6.11.0-8-generic #8-Ubuntu SMP Mon Sep 16 12:49:35 UTC 2024 118s autopkgtest [11:46:07]: @@@@@@@@@@@@@@@@@@@@ apt-source libpff 122s Get:1 http://ftpmaster.internal/ubuntu plucky/universe libpff 20180714-3.1build1 (dsc) [2430 B] 122s Get:2 http://ftpmaster.internal/ubuntu plucky/universe libpff 20180714-3.1build1 (tar) [1992 kB] 122s Get:3 http://ftpmaster.internal/ubuntu plucky/universe libpff 20180714-3.1build1 (diff) [16.3 kB] 122s gpgv: Signature made Sun Mar 31 19:29:38 2024 UTC 122s gpgv: using RSA key AC483F68DE728F43F2202FCA568D30F321B2133D 122s gpgv: issuer "steve.langasek@ubuntu.com" 122s gpgv: Can't check signature: No public key 122s dpkg-source: warning: cannot verify inline signature for ./libpff_20180714-3.1build1.dsc: no acceptable signature found 122s autopkgtest [11:46:11]: testing package libpff version 20180714-3.1build1 122s autopkgtest [11:46:11]: build not needed 126s autopkgtest [11:46:15]: test pfftools: preparing testbed 127s Reading package lists... 127s Building dependency tree... 127s Reading state information... 128s Starting pkgProblemResolver with broken count: 0 128s Starting 2 pkgProblemResolver with broken count: 0 128s Done 128s The following additional packages will be installed: 128s libbfio1 libpff1t64 pff-tools 128s The following NEW packages will be installed: 128s autopkgtest-satdep libbfio1 libpff1t64 pff-tools 128s 0 upgraded, 4 newly installed, 0 to remove and 0 not upgraded. 128s Need to get 1222 kB/1223 kB of archives. 128s After this operation, 3537 kB of additional disk space will be used. 128s Get:1 /tmp/autopkgtest.YUipTz/1-autopkgtest-satdep.deb autopkgtest-satdep s390x 0 [716 B] 128s Get:2 http://ftpmaster.internal/ubuntu plucky/universe s390x libbfio1 s390x 20170123-6 [302 kB] 128s Get:3 http://ftpmaster.internal/ubuntu plucky/universe s390x libpff1t64 s390x 20180714-3.1build1 [535 kB] 128s Get:4 http://ftpmaster.internal/ubuntu plucky/universe s390x pff-tools s390x 20180714-3.1build1 [386 kB] 129s Fetched 1222 kB in 1s (2196 kB/s) 129s Selecting previously unselected package libbfio1:s390x. 129s (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 ... 55517 files and directories currently installed.) 129s Preparing to unpack .../libbfio1_20170123-6_s390x.deb ... 129s Unpacking libbfio1:s390x (20170123-6) ... 129s Selecting previously unselected package libpff1t64. 129s Preparing to unpack .../libpff1t64_20180714-3.1build1_s390x.deb ... 129s Unpacking libpff1t64 (20180714-3.1build1) ... 129s Selecting previously unselected package pff-tools. 129s Preparing to unpack .../pff-tools_20180714-3.1build1_s390x.deb ... 129s Unpacking pff-tools (20180714-3.1build1) ... 129s Selecting previously unselected package autopkgtest-satdep. 129s Preparing to unpack .../1-autopkgtest-satdep.deb ... 129s Unpacking autopkgtest-satdep (0) ... 129s Setting up libbfio1:s390x (20170123-6) ... 129s Setting up libpff1t64 (20180714-3.1build1) ... 129s Setting up pff-tools (20180714-3.1build1) ... 129s Setting up autopkgtest-satdep (0) ... 129s Processing triggers for man-db (2.12.1-3) ... 129s Processing triggers for libc-bin (2.40-1ubuntu3) ... 131s (Reading database ... 55537 files and directories currently installed.) 131s Removing autopkgtest-satdep (0) ... 131s autopkgtest [11:46:20]: test pfftools: [----------------------- 132s Downloading input/public/outlook.pst 133s PASS: test_pffexport.sh 133s PASS: test_pffinfo.sh 134s autopkgtest [11:46:23]: test pfftools: -----------------------] 134s autopkgtest [11:46:23]: test pfftools: - - - - - - - - - - results - - - - - - - - - - 134s pfftools PASS 135s autopkgtest [11:46:24]: @@@@@@@@@@@@@@@@@@@@ summary 135s pfftools PASS 140s virt: nova [W] Using flock in prodstack6-s390x 140s virt: flock: timeout while waiting to get lock 140s virt: Creating nova instance adt-plucky-s390x-libpff-20241113-114408-juju-7f2275-prod-proposed-migration-environment-2-7474d364-bb38-44e6-b9c3-4bab54543cc9 from image adt/ubuntu-plucky-s390x-server-20241113.img (UUID e740277e-1f72-40ae-bfbe-46030537c71c)...