0s autopkgtest [21:28:21]: starting date and time: 2024-03-25 21:28:21+0000 0s autopkgtest [21:28:21]: git checkout: 4a1cd702 l/adt_testbed: don't blame the testbed for unsolvable build deps 0s autopkgtest [21:28:21]: host juju-7f2275-prod-proposed-migration-environment-2; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.w1k4r0j8/out --timeout-copy=6000 --setup-commands /home/ubuntu/autopkgtest-cloud/worker-config-production/setup-canonical.sh --setup-commands /home/ubuntu/autopkgtest/setup-commands/setup-testbed --apt-pocket=proposed=src:snowdrop,src:gnutls28,src:nettle --apt-upgrade snowdrop --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 '--env=ADT_TEST_TRIGGERS=snowdrop/0.02b-14build1 gnutls28/3.8.3-1.1ubuntu2 nettle/3.9.1-2.2' -- ssh -s /home/ubuntu/autopkgtest/ssh-setup/nova -- --flavor autopkgtest --security-groups autopkgtest-juju-7f2275-prod-proposed-migration-environment-2@bos02-s390x-5.secgroup --name adt-noble-s390x-snowdrop-20240325-212821-juju-7f2275-prod-proposed-migration-environment-2 --image adt/ubuntu-noble-s390x-server --keyname testbed-juju-7f2275-prod-proposed-migration-environment-2 --net-id=net_prod-proposed-migration -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,launchpadlibrarian.net,launchpadcontent.net,launchpad.net,10.24.0.0/24,keystone.ps5.canonical.com,objectstorage.prodstack5.canonical.com'"'"'' --mirror=http://ftpmaster.internal/ubuntu/ 72s autopkgtest [21:29:33]: testbed dpkg architecture: s390x 72s autopkgtest [21:29:33]: testbed apt version: 2.7.12 72s autopkgtest [21:29:33]: @@@@@@@@@@@@@@@@@@@@ test bed setup 73s Get:1 http://ftpmaster.internal/ubuntu noble-proposed InRelease [117 kB] 74s Get:2 http://ftpmaster.internal/ubuntu noble-proposed/restricted Sources [7608 B] 74s Get:3 http://ftpmaster.internal/ubuntu noble-proposed/multiverse Sources [56.0 kB] 74s Get:4 http://ftpmaster.internal/ubuntu noble-proposed/universe Sources [4038 kB] 75s Get:5 http://ftpmaster.internal/ubuntu noble-proposed/main Sources [497 kB] 75s Get:6 http://ftpmaster.internal/ubuntu noble-proposed/main s390x Packages [692 kB] 76s Get:7 http://ftpmaster.internal/ubuntu noble-proposed/main s390x c-n-f Metadata [3032 B] 76s Get:8 http://ftpmaster.internal/ubuntu noble-proposed/restricted s390x Packages [1372 B] 76s Get:9 http://ftpmaster.internal/ubuntu noble-proposed/restricted s390x c-n-f Metadata [116 B] 76s Get:10 http://ftpmaster.internal/ubuntu noble-proposed/universe s390x Packages [4136 kB] 77s Get:11 http://ftpmaster.internal/ubuntu noble-proposed/universe s390x c-n-f Metadata [7292 B] 77s Get:12 http://ftpmaster.internal/ubuntu noble-proposed/multiverse s390x Packages [47.8 kB] 77s Get:13 http://ftpmaster.internal/ubuntu noble-proposed/multiverse s390x c-n-f Metadata [116 B] 79s Fetched 9603 kB in 5s (2115 kB/s) 79s Reading package lists... 82s Reading package lists... 82s Building dependency tree... 82s Reading state information... 82s Calculating upgrade... 82s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 82s Reading package lists... 82s Building dependency tree... 82s Reading state information... 82s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 83s Unknown architecture, assuming PC-style ttyS0 83s sh: Attempting to set up Debian/Ubuntu apt sources automatically 83s sh: Distribution appears to be Ubuntu 84s Reading package lists... 84s Building dependency tree... 84s Reading state information... 84s eatmydata is already the newest version (131-1). 84s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 84s Reading package lists... 84s Building dependency tree... 84s Reading state information... 84s dbus is already the newest version (1.14.10-4ubuntu1). 84s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 84s Reading package lists... 84s Building dependency tree... 84s Reading state information... 85s rng-tools-debian is already the newest version (2.4). 85s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 85s Reading package lists... 85s Building dependency tree... 85s Reading state information... 85s The following packages will be REMOVED: 85s cloud-init* python3-configobj* python3-debconf* 85s 0 upgraded, 0 newly installed, 3 to remove and 0 not upgraded. 85s After this operation, 3256 kB disk space will be freed. 85s (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 ... 52170 files and directories currently installed.) 85s Removing cloud-init (24.1.2-0ubuntu1) ... 86s Removing python3-configobj (5.0.8-3) ... 86s Removing python3-debconf (1.5.86) ... 86s Processing triggers for man-db (2.12.0-3) ... 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 ... 51781 files and directories currently installed.) 87s Purging configuration files for cloud-init (24.1.2-0ubuntu1) ... 87s dpkg: warning: while removing cloud-init, directory '/etc/cloud/cloud.cfg.d' not empty so not removed 87s Processing triggers for rsyslog (8.2312.0-3ubuntu3) ... 87s invoke-rc.d: policy-rc.d denied execution of try-restart. 87s Reading package lists... 87s Building dependency tree... 87s Reading state information... 88s linux-generic is already the newest version (6.8.0-11.11+1). 88s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 88s Hit:1 http://ftpmaster.internal/ubuntu noble InRelease 88s Hit:2 http://ftpmaster.internal/ubuntu noble-updates InRelease 88s Hit:3 http://ftpmaster.internal/ubuntu noble-security InRelease 90s Reading package lists... 90s Reading package lists... 90s Building dependency tree... 90s Reading state information... 90s Calculating upgrade... 90s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 90s Reading package lists... 90s Building dependency tree... 90s Reading state information... 90s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 91s autopkgtest [21:29:52]: rebooting testbed after setup commands that affected boot 108s autopkgtest [21:30:09]: testbed running kernel: Linux 6.8.0-11-generic #11-Ubuntu SMP Tue Feb 13 23:45:46 UTC 2024 111s autopkgtest [21:30:12]: @@@@@@@@@@@@@@@@@@@@ apt-source snowdrop 113s Get:1 http://ftpmaster.internal/ubuntu noble/universe snowdrop 0.02b-14 (dsc) [2023 B] 113s Get:2 http://ftpmaster.internal/ubuntu noble/universe snowdrop 0.02b-14 (tar) [32.1 kB] 113s Get:3 http://ftpmaster.internal/ubuntu noble/universe snowdrop 0.02b-14 (diff) [8776 B] 113s gpgv: Signature made Wed Oct 26 02:28:15 2022 UTC 113s gpgv: using RSA key 0D352E9C68732B26568FD95E1C88E868846980DE 113s gpgv: Can't check signature: No public key 113s dpkg-source: warning: cannot verify inline signature for ./snowdrop_0.02b-14.dsc: no acceptable signature found 113s autopkgtest [21:30:14]: testing package snowdrop version 0.02b-14 113s autopkgtest [21:30:14]: build not needed 114s autopkgtest [21:30:15]: test command1: preparing testbed 117s Reading package lists... 117s Building dependency tree... 117s Reading state information... 117s Starting pkgProblemResolver with broken count: 0 118s Starting 2 pkgProblemResolver with broken count: 0 118s Done 118s The following additional packages will be installed: 118s libgnutls-openssl27 snowdrop 118s The following NEW packages will be installed: 118s autopkgtest-satdep libgnutls-openssl27 snowdrop 118s 0 upgraded, 3 newly installed, 0 to remove and 0 not upgraded. 118s Need to get 80.9 kB/81.6 kB of archives. 118s After this operation, 291 kB of additional disk space will be used. 118s Get:1 /tmp/autopkgtest.4bk80c/1-autopkgtest-satdep.deb autopkgtest-satdep s390x 0 [704 B] 118s Get:2 http://ftpmaster.internal/ubuntu noble/main s390x libgnutls-openssl27 s390x 3.8.3-1ubuntu1 [23.6 kB] 118s Get:3 http://ftpmaster.internal/ubuntu noble/universe s390x snowdrop s390x 0.02b-14 [57.3 kB] 118s Fetched 80.9 kB in 0s (172 kB/s) 118s Selecting previously unselected package libgnutls-openssl27:s390x. 119s (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 ... 51726 files and directories currently installed.) 119s Preparing to unpack .../libgnutls-openssl27_3.8.3-1ubuntu1_s390x.deb ... 119s Unpacking libgnutls-openssl27:s390x (3.8.3-1ubuntu1) ... 119s Selecting previously unselected package snowdrop. 119s Preparing to unpack .../snowdrop_0.02b-14_s390x.deb ... 119s Unpacking snowdrop (0.02b-14) ... 119s Selecting previously unselected package autopkgtest-satdep. 119s Preparing to unpack .../1-autopkgtest-satdep.deb ... 119s Unpacking autopkgtest-satdep (0) ... 119s Setting up libgnutls-openssl27:s390x (3.8.3-1ubuntu1) ... 119s Setting up snowdrop (0.02b-14) ... 119s Setting up autopkgtest-satdep (0) ... 119s Processing triggers for man-db (2.12.0-3) ... 119s Processing triggers for libc-bin (2.39-0ubuntu6) ... 121s (Reading database ... 51745 files and directories currently installed.) 121s Removing autopkgtest-satdep (0) ... 122s autopkgtest [21:30:23]: test command1: sd-c 122s autopkgtest [21:30:23]: test command1: [----------------------- 122s snowdrop 0.02b: text watermarking / watermark recovery by lcamtuf@coredump.cx 122s 122s [*] Weak 32-bit watermarking used (use -6 to change it). 122s Usage: sd-c [ -6 ] -e origfile newfile 122s sd-c [ -6 ] -l 122s sd-c [ -6 ] -i origfile newfile "Recipient" [ "Comment" ] 122s 122s First method of calling the program (with -e option) enables watermark 122s extraction mode. In this mode, file passed as a first parameter must be 122s the original document used to generate second file (or its portions). 122s 122s Second method (-l) simply lists the contents of the watermark database 122s for the module you're now running. 122s 122s Third method (-i) enables watermark injection mode. File 'origfile' is 122s modified and saved as 'newfile'. Mandatory parameter is the recipient 122s identifier. Optional comment can be added for your reference. 122s 122s Additional parameter -6 enables strong, 64-bit watermarking that is suitable 122s for providing public documentation of watermarked document abuse. 122s 122s 122s autopkgtest [21:30:23]: test command1: -----------------------] 123s autopkgtest [21:30:24]: test command1: - - - - - - - - - - results - - - - - - - - - - 123s command1 PASS (superficial) 123s autopkgtest [21:30:24]: test command2: preparing testbed 126s Reading package lists... 126s Building dependency tree... 126s Reading state information... 126s Starting pkgProblemResolver with broken count: 0 126s Starting 2 pkgProblemResolver with broken count: 0 126s Done 126s The following NEW packages will be installed: 126s autopkgtest-satdep 126s 0 upgraded, 1 newly installed, 0 to remove and 0 not upgraded. 126s Need to get 0 B/704 B of archives. 126s After this operation, 0 B of additional disk space will be used. 126s Get:1 /tmp/autopkgtest.4bk80c/2-autopkgtest-satdep.deb autopkgtest-satdep s390x 0 [704 B] 127s Selecting previously unselected package autopkgtest-satdep. 127s (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 ... 51745 files and directories currently installed.) 127s Preparing to unpack .../2-autopkgtest-satdep.deb ... 127s Unpacking autopkgtest-satdep (0) ... 127s Setting up autopkgtest-satdep (0) ... 128s (Reading database ... 51745 files and directories currently installed.) 128s Removing autopkgtest-satdep (0) ... 129s autopkgtest [21:30:30]: test command2: sd-eng 129s autopkgtest [21:30:30]: test command2: [----------------------- 129s snowdrop 0.02b: text watermarking / watermark recovery by lcamtuf@coredump.cx 129s 129s [*] Weak 32-bit watermarking used (use -6 to change it). 129s Usage: sd-eng [ -6 ] -e origfile newfile 129s sd-eng [ -6 ] -l 129s sd-eng [ -6 ] -i origfile newfile "Recipient" [ "Comment" ] 129s 129s First method of calling the program (with -e option) enables watermark 129s extraction mode. In this mode, file passed as a first parameter must be 129s the original document used to generate second file (or its portions). 129s 129s Second method (-l) simply lists the contents of the watermark database 129s for the module you're now running. 129s 129s Third method (-i) enables watermark injection mode. File 'origfile' is 129s modified and saved as 'newfile'. Mandatory parameter is the recipient 129s identifier. Optional comment can be added for your reference. 129s 129s Additional parameter -6 enables strong, 64-bit watermarking that is suitable 129s for providing public documentation of watermarked document abuse. 129s 129s This module supports SD_SYNONYMS environment variable that should 129s point to an alternative 'synonyms' file, if necessary. Make sure 129s to keep the copy of used alternative file for further reference. 129s 130s autopkgtest [21:30:31]: test command2: -----------------------] 130s command2 PASS (superficial) 130s autopkgtest [21:30:31]: test command2: - - - - - - - - - - results - - - - - - - - - - 131s autopkgtest [21:30:32]: test command3: preparing testbed 134s Reading package lists... 134s Building dependency tree... 134s Reading state information... 134s Starting pkgProblemResolver with broken count: 0 134s Starting 2 pkgProblemResolver with broken count: 0 134s Done 134s The following NEW packages will be installed: 134s autopkgtest-satdep 134s 0 upgraded, 1 newly installed, 0 to remove and 0 not upgraded. 134s Need to get 0 B/704 B of archives. 134s After this operation, 0 B of additional disk space will be used. 134s Get:1 /tmp/autopkgtest.4bk80c/3-autopkgtest-satdep.deb autopkgtest-satdep s390x 0 [704 B] 134s Selecting previously unselected package autopkgtest-satdep. 134s (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 ... 51745 files and directories currently installed.) 134s Preparing to unpack .../3-autopkgtest-satdep.deb ... 134s Unpacking autopkgtest-satdep (0) ... 134s Setting up autopkgtest-satdep (0) ... 136s (Reading database ... 51745 files and directories currently installed.) 136s Removing autopkgtest-satdep (0) ... 137s autopkgtest [21:30:38]: test command3: sd-engf 137s autopkgtest [21:30:38]: test command3: [----------------------- 137s snowdrop 0.02b: text watermarking / watermark recovery by lcamtuf@coredump.cx 137s 137s [*] Weak 32-bit watermarking used (use -6 to change it). 137s Usage: sd-engf [ -6 ] -e origfile newfile 137s sd-engf [ -6 ] -l 137s sd-engf [ -6 ] -i origfile newfile "Recipient" [ "Comment" ] 137s 137s First method of calling the program (with -e option) enables watermark 137s extraction mode. In this mode, file passed as a first parameter must be 137s the original document used to generate second file (or its portions). 137s 137s Second method (-l) simply lists the contents of the watermark database 137s for the module you're now running. 137s 137s Third method (-i) enables watermark injection mode. File 'origfile' is 137s modified and saved as 'newfile'. Mandatory parameter is the recipient 137s identifier. Optional comment can be added for your reference. 137s 137s Additional parameter -6 enables strong, 64-bit watermarking that is suitable 137s for providing public documentation of watermarked document abuse. 137s 137s This module supports SD_SYNONYMS environment variable that should 137s point to an alternative 'synonyms' file, if necessary. Make sure 137s to keep the copy of used alternative file for further reference. 137s 137s autopkgtest [21:30:38]: test command3: -----------------------] 138s autopkgtest [21:30:39]: test command3: - - - - - - - - - - results - - - - - - - - - - 138s command3 PASS (superficial) 138s autopkgtest [21:30:39]: test command4: preparing testbed 143s Reading package lists... 143s Building dependency tree... 143s Reading state information... 143s Starting pkgProblemResolver with broken count: 0 143s Starting 2 pkgProblemResolver with broken count: 0 143s Done 143s The following NEW packages will be installed: 143s autopkgtest-satdep 143s 0 upgraded, 1 newly installed, 0 to remove and 0 not upgraded. 143s Need to get 0 B/704 B of archives. 143s After this operation, 0 B of additional disk space will be used. 143s Get:1 /tmp/autopkgtest.4bk80c/4-autopkgtest-satdep.deb autopkgtest-satdep s390x 0 [704 B] 144s Selecting previously unselected package autopkgtest-satdep. 144s (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 ... 51745 files and directories currently installed.) 144s Preparing to unpack .../4-autopkgtest-satdep.deb ... 144s Unpacking autopkgtest-satdep (0) ... 144s Setting up autopkgtest-satdep (0) ... 145s (Reading database ... 51745 files and directories currently installed.) 145s Removing autopkgtest-satdep (0) ... 146s autopkgtest [21:30:47]: test command4: HOME=/tmp sd-eng -l 2>&1 | grep FATAL; HOME=/tmp sd-eng -i README $AUTOPKGTEST_TMP/copy "John Doe" "john@example.com"; HOME=/tmp sd-eng -l 2>&1 | grep "John Doe"; HOME=/tmp sd-eng -e README $AUTOPKGTEST_TMP/copy 2>&1 | grep "John Doe"; rm -rf /tmp/.snowdrop; 146s autopkgtest [21:30:47]: test command4: [----------------------- 146s snowdrop 0.02b: text watermarking / watermark recovery by lcamtuf@coredump.cx 146s 146s [*] Weak 32-bit watermarking used (use -6 to change it). 146s [-] FATAL: cannot open database file /tmp/.snowdrop/database 146s [+] Loaded 533 synonyms (587 lines parsed). 146s [+] Input file loaded successfully. 146s Location : README 146s Size : 25316 bytes 146s Signature : e264656f-d41c64f2 146s Recipient : John Doe 146s Comment : john@example.com 146s Magic : bcb5a4c0-3055babb 146s Watermark : 94917b96 146s Conf MD5 : a067c8bf 146s [*] Computed capacity: 3437 bits overall. 146s Target specification : draft / e-mail quality technical text [eng] 146s Overall redundancy : 107.41 (3437 bits) 146s Whitespace channel : 75.22 (2407 bits) 146s Grammar channel : 4.53 (145 bits) 146s Formatting channel : 16.84 (539 bits) 146s Substitution channel : 10.81 (346 bits) 146s Channel offsets are : 0, 8, 16, 24 146s [*] Embedding the watermark... 146s [+] Done. Written 32039 bytes to file '/tmp/autopkgtest.4bk80c/autopkgtest_tmp/copy', 3437 bits embedded. 147s autopkgtest [21:30:48]: test command4: -----------------------] 147s command4 FAIL non-zero exit status 1 147s autopkgtest [21:30:48]: test command4: - - - - - - - - - - results - - - - - - - - - - 148s autopkgtest [21:30:49]: @@@@@@@@@@@@@@@@@@@@ summary 148s command1 PASS (superficial) 148s command2 PASS (superficial) 148s command3 PASS (superficial) 148s command4 FAIL non-zero exit status 1 159s Creating nova instance adt-noble-s390x-snowdrop-20240325-212821-juju-7f2275-prod-proposed-migration-environment-2 from image adt/ubuntu-noble-s390x-server-20240325.img (UUID 9f25d9bc-613c-4979-9452-2ea8e4d84cd0)...