0s autopkgtest [16:48:09]: starting date and time: 2025-03-15 16:48:09+0000 0s autopkgtest [16:48:09]: git checkout: 325255d2 Merge branch 'pin-any-arch' into 'ubuntu/production' 0s autopkgtest [16:48:09]: host juju-7f2275-prod-proposed-migration-environment-9; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.ua0fmnvu/out --timeout-copy=6000 --setup-commands 'ln -s /dev/null /etc/systemd/system/bluetooth.service; printf "http_proxy=http://squid.internal:3128\nhttps_proxy=http://squid.internal:3128\nno_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,radosgw.ps5.canonical.com\n" >> /etc/environment' --apt-pocket=proposed=src:glibc --apt-upgrade racon --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 --env=ADT_TEST_TRIGGERS=glibc/2.41-1ubuntu2 -- lxd -r lxd-armhf-10.145.243.85 lxd-armhf-10.145.243.85:autopkgtest/ubuntu/plucky/armhf 20s autopkgtest [16:48:29]: testbed dpkg architecture: armhf 21s autopkgtest [16:48:30]: testbed apt version: 2.9.33 25s autopkgtest [16:48:34]: @@@@@@@@@@@@@@@@@@@@ test bed setup 27s autopkgtest [16:48:36]: testbed release detected to be: None 35s autopkgtest [16:48:44]: updating testbed package index (apt update) 37s Get:1 http://ftpmaster.internal/ubuntu plucky-proposed InRelease [126 kB] 37s Get:2 http://ftpmaster.internal/ubuntu plucky InRelease [257 kB] 37s Get:3 http://ftpmaster.internal/ubuntu plucky-updates InRelease [126 kB] 37s Get:4 http://ftpmaster.internal/ubuntu plucky-security InRelease [126 kB] 38s Get:5 http://ftpmaster.internal/ubuntu plucky-proposed/universe Sources [379 kB] 38s Get:6 http://ftpmaster.internal/ubuntu plucky-proposed/main Sources [99.7 kB] 38s Get:7 http://ftpmaster.internal/ubuntu plucky-proposed/multiverse Sources [15.8 kB] 38s Get:8 http://ftpmaster.internal/ubuntu plucky-proposed/main armhf Packages [114 kB] 38s Get:9 http://ftpmaster.internal/ubuntu plucky-proposed/main armhf c-n-f Metadata [1832 B] 38s Get:10 http://ftpmaster.internal/ubuntu plucky-proposed/restricted armhf c-n-f Metadata [116 B] 38s Get:11 http://ftpmaster.internal/ubuntu plucky-proposed/universe armhf Packages [312 kB] 39s Get:12 http://ftpmaster.internal/ubuntu plucky-proposed/universe armhf c-n-f Metadata [11.1 kB] 39s Get:13 http://ftpmaster.internal/ubuntu plucky-proposed/multiverse armhf Packages [3472 B] 39s Get:14 http://ftpmaster.internal/ubuntu plucky-proposed/multiverse armhf c-n-f Metadata [240 B] 39s Get:15 http://ftpmaster.internal/ubuntu plucky/multiverse Sources [299 kB] 39s Get:16 http://ftpmaster.internal/ubuntu plucky/main Sources [1394 kB] 40s Get:17 http://ftpmaster.internal/ubuntu plucky/universe Sources [21.0 MB] 64s Get:18 http://ftpmaster.internal/ubuntu plucky/main armhf Packages [1378 kB] 66s Get:19 http://ftpmaster.internal/ubuntu plucky/main armhf c-n-f Metadata [29.4 kB] 66s Get:20 http://ftpmaster.internal/ubuntu plucky/restricted armhf c-n-f Metadata [108 B] 66s Get:21 http://ftpmaster.internal/ubuntu plucky/universe armhf Packages [15.1 MB] 83s Get:22 http://ftpmaster.internal/ubuntu plucky/multiverse armhf Packages [172 kB] 85s Fetched 41.0 MB in 48s (850 kB/s) 87s Reading package lists... 92s autopkgtest [16:49:41]: upgrading testbed (apt dist-upgrade and autopurge) 94s Reading package lists... 95s Building dependency tree... 95s Reading state information... 96s Calculating upgrade...Starting pkgProblemResolver with broken count: 0 96s Starting 2 pkgProblemResolver with broken count: 0 96s Done 97s Entering ResolveByKeep 98s 98s Calculating upgrade... 99s The following packages will be upgraded: 99s libc-bin libc6 locales pinentry-curses python3-jinja2 sos strace 99s 7 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 99s Need to get 8683 kB of archives. 99s After this operation, 23.6 kB of additional disk space will be used. 99s Get:1 http://ftpmaster.internal/ubuntu plucky-proposed/main armhf libc6 armhf 2.41-1ubuntu2 [2932 kB] 102s Get:2 http://ftpmaster.internal/ubuntu plucky-proposed/main armhf libc-bin armhf 2.41-1ubuntu2 [545 kB] 103s Get:3 http://ftpmaster.internal/ubuntu plucky-proposed/main armhf locales all 2.41-1ubuntu2 [4246 kB] 107s Get:4 http://ftpmaster.internal/ubuntu plucky/main armhf strace armhf 6.13+ds-1ubuntu1 [445 kB] 107s Get:5 http://ftpmaster.internal/ubuntu plucky/main armhf pinentry-curses armhf 1.3.1-2ubuntu3 [40.6 kB] 108s Get:6 http://ftpmaster.internal/ubuntu plucky/main armhf python3-jinja2 all 3.1.5-2ubuntu1 [109 kB] 108s Get:7 http://ftpmaster.internal/ubuntu plucky/main armhf sos all 4.9.0-5 [365 kB] 109s Preconfiguring packages ... 109s Fetched 8683 kB in 9s (984 kB/s) 109s (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 ... 64655 files and directories currently installed.) 109s Preparing to unpack .../libc6_2.41-1ubuntu2_armhf.deb ... 109s Unpacking libc6:armhf (2.41-1ubuntu2) over (2.41-1ubuntu1) ... 110s Setting up libc6:armhf (2.41-1ubuntu2) ... 110s (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 ... 64655 files and directories currently installed.) 110s Preparing to unpack .../libc-bin_2.41-1ubuntu2_armhf.deb ... 110s Unpacking libc-bin (2.41-1ubuntu2) over (2.41-1ubuntu1) ... 110s Setting up libc-bin (2.41-1ubuntu2) ... 110s (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 ... 64655 files and directories currently installed.) 110s Preparing to unpack .../locales_2.41-1ubuntu2_all.deb ... 110s Unpacking locales (2.41-1ubuntu2) over (2.41-1ubuntu1) ... 111s Preparing to unpack .../strace_6.13+ds-1ubuntu1_armhf.deb ... 111s Unpacking strace (6.13+ds-1ubuntu1) over (6.11-0ubuntu1) ... 111s Preparing to unpack .../pinentry-curses_1.3.1-2ubuntu3_armhf.deb ... 111s Unpacking pinentry-curses (1.3.1-2ubuntu3) over (1.3.1-2ubuntu2) ... 111s Preparing to unpack .../python3-jinja2_3.1.5-2ubuntu1_all.deb ... 111s Unpacking python3-jinja2 (3.1.5-2ubuntu1) over (3.1.5-2) ... 111s Preparing to unpack .../archives/sos_4.9.0-5_all.deb ... 111s Unpacking sos (4.9.0-5) over (4.9.0-4) ... 112s Setting up sos (4.9.0-5) ... 113s Setting up pinentry-curses (1.3.1-2ubuntu3) ... 113s Setting up locales (2.41-1ubuntu2) ... 114s Generating locales (this might take a while)... 117s en_US.UTF-8... done 117s Generation complete. 117s Setting up python3-jinja2 (3.1.5-2ubuntu1) ... 118s Setting up strace (6.13+ds-1ubuntu1) ... 118s Processing triggers for man-db (2.13.0-1) ... 119s Processing triggers for systemd (257.3-1ubuntu3) ... 122s Reading package lists... 122s Building dependency tree... 122s Reading state information... 123s Starting pkgProblemResolver with broken count: 0 124s Starting 2 pkgProblemResolver with broken count: 0 124s Done 124s Solving dependencies... 126s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 128s autopkgtest [16:50:17]: rebooting testbed after setup commands that affected boot 168s autopkgtest [16:50:57]: testbed running kernel: Linux 6.8.0-52-generic #53~22.04.1-Ubuntu SMP PREEMPT_DYNAMIC Wed Jan 15 18:10:51 UTC 2 202s autopkgtest [16:51:31]: @@@@@@@@@@@@@@@@@@@@ apt-source racon 217s Get:1 http://ftpmaster.internal/ubuntu plucky/universe racon 1.5.0-3 (dsc) [2106 B] 217s Get:2 http://ftpmaster.internal/ubuntu plucky/universe racon 1.5.0-3 (tar) [3084 kB] 217s Get:3 http://ftpmaster.internal/ubuntu plucky/universe racon 1.5.0-3 (diff) [20.7 kB] 217s gpgv: Signature made Thu Sep 29 12:45:21 2022 UTC 217s gpgv: using RSA key F1F007320A035541F0A663CA578A0494D1C646D1 217s gpgv: issuer "tille@debian.org" 217s gpgv: Can't check signature: No public key 217s dpkg-source: warning: cannot verify inline signature for ./racon_1.5.0-3.dsc: no acceptable signature found 217s autopkgtest [16:51:46]: testing package racon version 1.5.0-3 219s autopkgtest [16:51:48]: build not needed 221s autopkgtest [16:51:50]: test run-unit-test: preparing testbed 223s Reading package lists... 224s Building dependency tree... 224s Reading state information... 224s Starting pkgProblemResolver with broken count: 0 224s Starting 2 pkgProblemResolver with broken count: 0 224s Done 226s The following NEW packages will be installed: 226s libedlib1 libspoa7.0.0 racon 226s 0 upgraded, 3 newly installed, 0 to remove and 0 not upgraded. 226s Need to get 3190 kB of archives. 226s After this operation, 3396 kB of additional disk space will be used. 226s Get:1 http://ftpmaster.internal/ubuntu plucky/universe armhf libedlib1 armhf 1.2.7-6build2 [16.2 kB] 226s Get:2 http://ftpmaster.internal/ubuntu plucky/universe armhf libspoa7.0.0 armhf 4.1.4-2 [67.2 kB] 226s Get:3 http://ftpmaster.internal/ubuntu plucky/universe armhf racon armhf 1.5.0-3 [3106 kB] 231s Fetched 3190 kB in 4s (759 kB/s) 231s Selecting previously unselected package libedlib1:armhf. 231s (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 ... 64655 files and directories currently installed.) 231s Preparing to unpack .../libedlib1_1.2.7-6build2_armhf.deb ... 231s Unpacking libedlib1:armhf (1.2.7-6build2) ... 231s Selecting previously unselected package libspoa7.0.0:armhf. 231s Preparing to unpack .../libspoa7.0.0_4.1.4-2_armhf.deb ... 231s Unpacking libspoa7.0.0:armhf (4.1.4-2) ... 231s Selecting previously unselected package racon. 231s Preparing to unpack .../racon_1.5.0-3_armhf.deb ... 231s Unpacking racon (1.5.0-3) ... 231s Setting up libspoa7.0.0:armhf (4.1.4-2) ... 231s Setting up libedlib1:armhf (1.2.7-6build2) ... 231s Setting up racon (1.5.0-3) ... 231s Processing triggers for man-db (2.13.0-1) ... 231s Processing triggers for libc-bin (2.41-1ubuntu2) ... 239s autopkgtest [16:52:08]: test run-unit-test: [----------------------- 242s [racon::Polisher::initialize] loaded target sequences 0.000697 s 242s [racon::Polisher::initialize] loaded sequences 0.035369 s 242s [racon::Polisher::initialize] loaded overlaps 0.000360 s 243s [racon::Polisher::initialize] aligning overlaps [=> ] 0.077398 s [racon::Polisher::initialize] aligning overlaps [==> ] 0.129037 s [racon::Polisher::initialize] aligning overlaps [===> ] 0.174600 s [racon::Polisher::initialize] aligning overlaps [====> ] 0.223699 s [racon::Polisher::initialize] aligning overlaps [=====> ] 0.266276 s [racon::Polisher::initialize] aligning overlaps [======> ] 0.299846 s [racon::Polisher::initialize] aligning overlaps [=======> ] 0.363045 s [racon::Polisher::initialize] aligning overlaps [========> ] 0.416102 s [racon::Polisher::initialize] aligning overlaps [=========> ] 0.472157 s [racon::Polisher::initialize] aligning overlaps [==========> ] 0.525676 s [racon::Polisher::initialize] aligning overlaps [===========> ] 0.567826 s [racon::Polisher::initialize] aligning overlaps [============> ] 0.635235 s [racon::Polisher::initialize] aligning overlaps [=============> ] 0.698050 s [racon::Polisher::initialize] aligning overlaps [==============> ] 0.738471 s [racon::Polisher::initialize] aligning overlaps [===============> ] 0.806179 s [racon::Polisher::initialize] aligning overlaps [================> ] 0.871661 s [racon::Polisher::initialize] aligning overlaps [=================> ] 0.923709 s [racon::Polisher::initialize] aligning overlaps [==================> ] 0.981844 s [racon::Polisher::initialize] aligning overlaps [===================>] 1.047733 s [racon::Polisher::initialize] aligning overlaps [====================] 1.124362 s 243s [racon::Polisher::initialize] transformed data into windows 0.001710 s 258s [racon::Polisher::polish] generating consensus [=> ] 0.610655 s [racon::Polisher::polish] generating consensus [==> ] 1.236035 s [racon::Polisher::polish] generating consensus [===> ] 1.856606 s [racon::Polisher::polish] generating consensus [====> ] 2.271479 s [racon::Polisher::polish] generating consensus [=====> ] 2.508844 s [racon::Polisher::polish] generating consensus [======> ] 2.763917 s [racon::Polisher::polish] generating consensus [=======> ] 3.009026 s [racon::Polisher::polish] generating consensus [========> ] 3.306980 s [racon::Polisher::polish] generating consensus [=========> ] 3.683933 s [racon::Polisher::polish] generating consensus [==========> ] 4.249108 s [racon::Polisher::polish] generating consensus [===========> ] 5.013601 s [racon::Polisher::polish] generating consensus [============> ] 5.867839 s [racon::Polisher::polish] generating consensus [=============> ] 7.034605 s [racon::Polisher::polish] generating consensus [==============> ] 8.213225 s [racon::Polisher::polish] generating consensus [===============> ] 9.118847 s [racon::Polisher::polish] generating consensus [================> ] 9.854202 s [racon::Polisher::polish] generating consensus [=================> ] 10.672700 s [racon::Polisher::polish] generating consensus [==================> ] 11.237343 s [racon::Polisher::polish] generating consensus [===================>] 11.831029 s [racon::Polisher::polish] generating consensus [====================] 14.849412 s 258s [racon::Polisher::] total = 16.012709 s 258s racon output matches expected output 258s PASS 258s autopkgtest [16:52:27]: test run-unit-test: -----------------------] 262s run-unit-test PASS 262s autopkgtest [16:52:31]: test run-unit-test: - - - - - - - - - - results - - - - - - - - - - 266s autopkgtest [16:52:35]: @@@@@@@@@@@@@@@@@@@@ summary 266s run-unit-test PASS