1s autopkgtest [13:13:18]: starting date and time: 2024-06-03 13:13:18+0000 1s autopkgtest [13:13:18]: git checkout: 930f72e5 setup-testbed: don't install 'Recommends' for 'linux-generic' 1s autopkgtest [13:13:18]: host juju-7f2275-prod-proposed-migration-environment-3; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.rgx8j391/out --timeout-copy=6000 --setup-commands /home/ubuntu/autopkgtest-cloud/worker-config-production/setup-canonical.sh --apt-pocket=proposed=src:libxml2,src:libxml-libxml-perl --apt-upgrade glusterfs --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 '--env=ADT_TEST_TRIGGERS=libxml2/2.12.7+dfsg-3 libxml-libxml-perl/2.0207+dfsg+really+2.0134-3' -- ssh -s /home/ubuntu/autopkgtest/ssh-setup/nova -- --flavor autopkgtest --security-groups autopkgtest-juju-7f2275-prod-proposed-migration-environment-3@bos01-ppc64el-14.secgroup --name adt-oracular-ppc64el-glusterfs-20240603-131315-juju-7f2275-prod-proposed-migration-environment-3-3dc3973e-e09f-46ea-a401-b7c2110962e7 --image adt/ubuntu-oracular-ppc64el-server --keyname testbed-juju-7f2275-prod-proposed-migration-environment-3 --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,keyserver.ubuntu.com,launchpadlibrarian.net,launchpadcontent.net,launchpad.net,10.24.0.0/24,keystone.ps5.canonical.com,objectstorage.prodstack5.canonical.com'"'"'' --mirror=http://us.ports.ubuntu.com/ubuntu-ports/ 201s autopkgtest [13:16:38]: testbed dpkg architecture: ppc64el 201s autopkgtest [13:16:38]: testbed apt version: 2.9.3 201s autopkgtest [13:16:38]: @@@@@@@@@@@@@@@@@@@@ test bed setup 202s Get:1 http://ftpmaster.internal/ubuntu oracular-proposed InRelease [110 kB] 202s Get:2 http://ftpmaster.internal/ubuntu oracular-proposed/restricted Sources [4792 B] 202s Get:3 http://ftpmaster.internal/ubuntu oracular-proposed/multiverse Sources [1680 B] 202s Get:4 http://ftpmaster.internal/ubuntu oracular-proposed/main Sources [43.4 kB] 202s Get:5 http://ftpmaster.internal/ubuntu oracular-proposed/universe Sources [384 kB] 203s Get:6 http://ftpmaster.internal/ubuntu oracular-proposed/main ppc64el Packages [69.7 kB] 203s Get:7 http://ftpmaster.internal/ubuntu oracular-proposed/universe ppc64el Packages [348 kB] 203s Get:8 http://ftpmaster.internal/ubuntu oracular-proposed/multiverse ppc64el Packages [1392 B] 203s Fetched 964 kB in 1s (1090 kB/s) 203s Reading package lists... 207s Reading package lists... 207s Building dependency tree... 207s Reading state information... 207s Calculating upgrade... 207s The following packages will be upgraded: 207s libxml2 208s 1 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 208s Need to get 728 kB of archives. 208s After this operation, 516 kB disk space will be freed. 208s Get:1 http://ftpmaster.internal/ubuntu oracular-proposed/main ppc64el libxml2 ppc64el 2.12.7+dfsg-3 [728 kB] 209s Fetched 728 kB in 1s (931 kB/s) 209s (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 ... 72606 files and directories currently installed.) 209s Preparing to unpack .../libxml2_2.12.7+dfsg-3_ppc64el.deb ... 209s Unpacking libxml2:ppc64el (2.12.7+dfsg-3) over (2.9.14+dfsg-1.3ubuntu3) ... 209s Setting up libxml2:ppc64el (2.12.7+dfsg-3) ... 209s Processing triggers for libc-bin (2.39-0ubuntu8.1) ... 209s Reading package lists... 209s Building dependency tree... 209s Reading state information... 209s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 210s Hit:1 http://ftpmaster.internal/ubuntu oracular-proposed InRelease 210s Hit:2 http://ftpmaster.internal/ubuntu oracular InRelease 210s Hit:3 http://ftpmaster.internal/ubuntu oracular-updates InRelease 210s Hit:4 http://ftpmaster.internal/ubuntu oracular-security InRelease 211s Reading package lists... 211s Reading package lists... 211s Building dependency tree... 211s Reading state information... 212s Calculating upgrade... 212s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 212s Reading package lists... 212s Building dependency tree... 212s Reading state information... 212s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 216s autopkgtest [13:16:53]: testbed running kernel: Linux 6.8.0-31-generic #31-Ubuntu SMP Sat Apr 20 00:05:55 UTC 2024 217s autopkgtest [13:16:54]: @@@@@@@@@@@@@@@@@@@@ apt-source glusterfs 232s Get:1 http://ftpmaster.internal/ubuntu oracular/universe glusterfs 11.1-4build3 (dsc) [3677 B] 232s Get:2 http://ftpmaster.internal/ubuntu oracular/universe glusterfs 11.1-4build3 (tar) [8366 kB] 232s Get:3 http://ftpmaster.internal/ubuntu oracular/universe glusterfs 11.1-4build3 (diff) [24.7 kB] 232s gpgv: Signature made Sun Mar 31 06:00:42 2024 UTC 232s gpgv: using RSA key AC483F68DE728F43F2202FCA568D30F321B2133D 232s gpgv: issuer "steve.langasek@ubuntu.com" 232s gpgv: Can't check signature: No public key 232s dpkg-source: warning: cannot verify inline signature for ./glusterfs_11.1-4build3.dsc: no acceptable signature found 233s autopkgtest [13:17:10]: testing package glusterfs version 11.1-4build3 241s autopkgtest [13:17:18]: build not needed 278s autopkgtest [13:17:55]: test smoke: preparing testbed 282s Reading package lists... 282s Building dependency tree... 282s Reading state information... 282s Starting pkgProblemResolver with broken count: 0 282s Starting 2 pkgProblemResolver with broken count: 0 282s Done 282s The following additional packages will be installed: 282s attr glusterfs-cli glusterfs-client glusterfs-common glusterfs-server 282s libacl1-dev libattr1-dev libgfapi0 libgfchangelog0 libgfrpc0 libgfxdr0 282s libglusterfs-dev libglusterfs0 python3-prettytable python3-wcwidth 282s Recommended packages: 282s nfs-common 282s The following NEW packages will be installed: 282s attr autopkgtest-satdep glusterfs-cli glusterfs-client glusterfs-common 282s glusterfs-server libacl1-dev libattr1-dev libgfapi0 libgfchangelog0 282s libgfrpc0 libgfxdr0 libglusterfs-dev libglusterfs0 python3-prettytable 282s python3-wcwidth 282s 0 upgraded, 16 newly installed, 0 to remove and 0 not upgraded. 282s Need to get 4175 kB/4176 kB of archives. 282s After this operation, 23.8 MB of additional disk space will be used. 282s Get:1 /tmp/autopkgtest.l5vkV5/1-autopkgtest-satdep.deb autopkgtest-satdep ppc64el 0 [764 B] 282s Get:2 http://ftpmaster.internal/ubuntu oracular/main ppc64el attr ppc64el 1:2.5.2-1build1 [26.1 kB] 282s Get:3 http://ftpmaster.internal/ubuntu oracular/universe ppc64el libgfxdr0 ppc64el 11.1-4build3 [21.5 kB] 282s Get:4 http://ftpmaster.internal/ubuntu oracular/universe ppc64el libglusterfs0 ppc64el 11.1-4build3 [311 kB] 283s Get:5 http://ftpmaster.internal/ubuntu oracular/universe ppc64el libgfrpc0 ppc64el 11.1-4build3 [47.0 kB] 283s Get:6 http://ftpmaster.internal/ubuntu oracular/universe ppc64el glusterfs-cli ppc64el 11.1-4build3 [210 kB] 283s Get:7 http://ftpmaster.internal/ubuntu oracular/universe ppc64el libgfapi0 ppc64el 11.1-4build3 [100 kB] 283s Get:8 http://ftpmaster.internal/ubuntu oracular/universe ppc64el libgfchangelog0 ppc64el 11.1-4build3 [30.0 kB] 283s Get:9 http://ftpmaster.internal/ubuntu oracular/main ppc64el python3-wcwidth all 0.2.5+dfsg1-1.1ubuntu1 [22.5 kB] 283s Get:10 http://ftpmaster.internal/ubuntu oracular/main ppc64el python3-prettytable all 3.6.0-2 [32.8 kB] 283s Get:11 http://ftpmaster.internal/ubuntu oracular/universe ppc64el glusterfs-common ppc64el 11.1-4build3 [3074 kB] 284s Get:12 http://ftpmaster.internal/ubuntu oracular/universe ppc64el glusterfs-client ppc64el 11.1-4build3 [28.4 kB] 284s Get:13 http://ftpmaster.internal/ubuntu oracular/universe ppc64el glusterfs-server ppc64el 11.1-4build3 [22.4 kB] 284s Get:14 http://ftpmaster.internal/ubuntu oracular/main ppc64el libattr1-dev ppc64el 1:2.5.2-1build1 [24.7 kB] 284s Get:15 http://ftpmaster.internal/ubuntu oracular/main ppc64el libacl1-dev ppc64el 2.3.2-2 [81.3 kB] 284s Get:16 http://ftpmaster.internal/ubuntu oracular/universe ppc64el libglusterfs-dev ppc64el 11.1-4build3 [143 kB] 285s Fetched 4175 kB in 2s (1969 kB/s) 285s Selecting previously unselected package attr. 285s (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 ... 72606 files and directories currently installed.) 285s Preparing to unpack .../00-attr_1%3a2.5.2-1build1_ppc64el.deb ... 285s Unpacking attr (1:2.5.2-1build1) ... 285s Selecting previously unselected package libgfxdr0:ppc64el. 285s Preparing to unpack .../01-libgfxdr0_11.1-4build3_ppc64el.deb ... 285s Unpacking libgfxdr0:ppc64el (11.1-4build3) ... 285s Selecting previously unselected package libglusterfs0:ppc64el. 285s Preparing to unpack .../02-libglusterfs0_11.1-4build3_ppc64el.deb ... 285s Unpacking libglusterfs0:ppc64el (11.1-4build3) ... 285s Selecting previously unselected package libgfrpc0:ppc64el. 285s Preparing to unpack .../03-libgfrpc0_11.1-4build3_ppc64el.deb ... 285s Unpacking libgfrpc0:ppc64el (11.1-4build3) ... 285s Selecting previously unselected package glusterfs-cli. 285s Preparing to unpack .../04-glusterfs-cli_11.1-4build3_ppc64el.deb ... 285s Unpacking glusterfs-cli (11.1-4build3) ... 285s Selecting previously unselected package libgfapi0:ppc64el. 285s Preparing to unpack .../05-libgfapi0_11.1-4build3_ppc64el.deb ... 285s Unpacking libgfapi0:ppc64el (11.1-4build3) ... 285s Selecting previously unselected package libgfchangelog0:ppc64el. 285s Preparing to unpack .../06-libgfchangelog0_11.1-4build3_ppc64el.deb ... 285s Unpacking libgfchangelog0:ppc64el (11.1-4build3) ... 285s Selecting previously unselected package python3-wcwidth. 285s Preparing to unpack .../07-python3-wcwidth_0.2.5+dfsg1-1.1ubuntu1_all.deb ... 285s Unpacking python3-wcwidth (0.2.5+dfsg1-1.1ubuntu1) ... 285s Selecting previously unselected package python3-prettytable. 285s Preparing to unpack .../08-python3-prettytable_3.6.0-2_all.deb ... 285s Unpacking python3-prettytable (3.6.0-2) ... 285s Selecting previously unselected package glusterfs-common. 285s Preparing to unpack .../09-glusterfs-common_11.1-4build3_ppc64el.deb ... 285s Unpacking glusterfs-common (11.1-4build3) ... 285s Selecting previously unselected package glusterfs-client. 285s Preparing to unpack .../10-glusterfs-client_11.1-4build3_ppc64el.deb ... 285s Unpacking glusterfs-client (11.1-4build3) ... 285s Selecting previously unselected package glusterfs-server. 285s Preparing to unpack .../11-glusterfs-server_11.1-4build3_ppc64el.deb ... 285s Unpacking glusterfs-server (11.1-4build3) ... 285s Selecting previously unselected package libattr1-dev:ppc64el. 285s Preparing to unpack .../12-libattr1-dev_1%3a2.5.2-1build1_ppc64el.deb ... 285s Unpacking libattr1-dev:ppc64el (1:2.5.2-1build1) ... 285s Selecting previously unselected package libacl1-dev:ppc64el. 285s Preparing to unpack .../13-libacl1-dev_2.3.2-2_ppc64el.deb ... 285s Unpacking libacl1-dev:ppc64el (2.3.2-2) ... 285s Selecting previously unselected package libglusterfs-dev. 285s Preparing to unpack .../14-libglusterfs-dev_11.1-4build3_ppc64el.deb ... 285s Unpacking libglusterfs-dev (11.1-4build3) ... 285s Selecting previously unselected package autopkgtest-satdep. 285s Preparing to unpack .../15-1-autopkgtest-satdep.deb ... 285s Unpacking autopkgtest-satdep (0) ... 285s Setting up libattr1-dev:ppc64el (1:2.5.2-1build1) ... 285s Setting up attr (1:2.5.2-1build1) ... 285s Setting up libglusterfs0:ppc64el (11.1-4build3) ... 285s Setting up python3-wcwidth (0.2.5+dfsg1-1.1ubuntu1) ... 285s Setting up python3-prettytable (3.6.0-2) ... 285s Setting up libgfxdr0:ppc64el (11.1-4build3) ... 285s Setting up libacl1-dev:ppc64el (2.3.2-2) ... 285s Setting up libgfrpc0:ppc64el (11.1-4build3) ... 285s Setting up libgfchangelog0:ppc64el (11.1-4build3) ... 285s Setting up libgfapi0:ppc64el (11.1-4build3) ... 285s Setting up glusterfs-cli (11.1-4build3) ... 285s Setting up glusterfs-common (11.1-4build3) ... 285s info: Selecting GID from range 100 to 999 ... 285s info: Adding group `gluster' (GID 108) ... 286s /usr/lib/powerpc64le-linux-gnu/glusterfs/python/syncdaemon/resource.py:807: SyntaxWarning: invalid escape sequence '\d' 286s for x in re.findall('(?:[\da-f]){2}', 286s Setting up libglusterfs-dev (11.1-4build3) ... 286s Setting up glusterfs-client (11.1-4build3) ... 286s Setting up glusterfs-server (11.1-4build3) ... 288s Setting up autopkgtest-satdep (0) ... 288s Processing triggers for man-db (2.12.1-1) ... 289s Processing triggers for libc-bin (2.39-0ubuntu8.1) ... 295s (Reading database ... 73165 files and directories currently installed.) 295s Removing autopkgtest-satdep (0) ... 296s autopkgtest [13:18:13]: test smoke: [----------------------- 299s ● glusterd.service - GlusterFS, a clustered file-system server 299s Loaded: loaded (/usr/lib/systemd/system/glusterd.service; disabled; preset: enabled) 299s Active: active (running) since Mon 2024-06-03 13:18:16 UTC; 11ms ago 299s Docs: man:glusterd(8) 299s Process: 2789 ExecStart=/usr/sbin/glusterd -p /var/run/glusterd.pid --log-level $LOG_LEVEL $GLUSTERD_OPTIONS (code=exited, status=0/SUCCESS) 299s Main PID: 2790 (glusterd) 299s Tasks: 9 (limit: 1623) 299s Memory: 14.8M (peak: 29.9M) 299s CPU: 1.543s 299s CGroup: /system.slice/glusterd.service 299s └─2790 /usr/sbin/glusterd -p /var/run/glusterd.pid --log-level INFO 299s 299s Jun 03 13:18:14 autopkgtest (glusterd)[2789]: glusterd.service: Referenced but unset environment variable evaluates to an empty string: GLUSTERD_OPTIONS 299s Jun 03 13:18:14 autopkgtest systemd[1]: Starting glusterd.service - GlusterFS, a clustered file-system server... 299s Jun 03 13:18:16 autopkgtest systemd[1]: Started glusterd.service - GlusterFS, a clustered file-system server. 299s Number of Peers: 0 299s UUID Hostname State 299s f900e29d-e8ad-4358-ae9e-ecca4dd21b99 localhost Connected 299s glusterd state dumped to /var/run/gluster/glusterd_state_20240603_131816 299s [Global] 299s MYUUID: f900e29d-e8ad-4358-ae9e-ecca4dd21b99 299s op-version: 110000 299s 299s [Global options] 299s 299s [Peers] 299s 299s [Volumes] 299s 299s [Services] 299s 299s [Misc] 299s Base port: 49152 299s autopkgtest [13:18:16]: test smoke: -----------------------] 300s autopkgtest [13:18:17]: test smoke: - - - - - - - - - - results - - - - - - - - - - 300s smoke PASS (superficial) 301s autopkgtest [13:18:18]: test create-volume: preparing testbed 303s Reading package lists... 303s Building dependency tree... 303s Reading state information... 303s Starting pkgProblemResolver with broken count: 0 303s Starting 2 pkgProblemResolver with broken count: 0 303s Done 303s The following NEW packages will be installed: 303s autopkgtest-satdep 303s 0 upgraded, 1 newly installed, 0 to remove and 0 not upgraded. 303s Need to get 0 B/772 B of archives. 303s After this operation, 0 B of additional disk space will be used. 303s Get:1 /tmp/autopkgtest.l5vkV5/2-autopkgtest-satdep.deb autopkgtest-satdep ppc64el 0 [772 B] 304s Selecting previously unselected package autopkgtest-satdep. 304s (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 ... 73165 files and directories currently installed.) 304s Preparing to unpack .../2-autopkgtest-satdep.deb ... 304s Unpacking autopkgtest-satdep (0) ... 304s Setting up autopkgtest-satdep (0) ... 310s (Reading database ... 73165 files and directories currently installed.) 310s Removing autopkgtest-satdep (0) ... 312s autopkgtest [13:18:29]: test create-volume: [----------------------- 312s 312s 312s Creating backend brick file 312s 5+0 records in 312s 5+0 records out 312s 524288000 bytes (524 MB, 500 MiB) copied, 0.31102 s, 1.7 GB/s 312s 312s 312s Formatting backend device /dev/loop0 with XFS 312s 312s 312s Mounting backend device /dev/loop0 313s 313s 313s Restarting glusterd service 314s Checking if glusterd is ready (3s timeout)... ready 314s 314s 314s Asserting there are no volumes yet 314s No volumes present in cluster 314s 314s 314s Creating gluster gv0 volume 314s volume create: gv0: success: please start the volume to access data 314s 314s 314s Starting gv0 volume 315s volume start: gv0: success 315s 315s 315s Verifying if volume gv0 started... Status: Started 315s 315s 315s Mounting volume gv0 315s 315s 315s Preparing test file 315s 1024+0 records in 315s 1024+0 records out 315s 1048576 bytes (1.0 MB, 1.0 MiB) copied, 0.00739567 s, 142 MB/s 315s 315s 315s Copying test file into volume gv0 315s 315s 315s Comparing copied data with source 315s 315s 315s Restaring glusterd and checking test file access again 316s Checking if glusterd is ready (3s timeout)... ready 316s Waiting for mount point to be ready (1) 317s Waiting for mount point to be ready (2) 318s 318s 318s Comparing copied data with source one more time 318s 318s 318s Cleaning up... 318s 318s Umounting volume 318s 318s Stopping volume gv0 320s volume stop: gv0: success 320s 320s Deleting volume gv0 320s volume delete: gv0: success 320s autopkgtest [13:18:37]: test create-volume: -----------------------] 321s autopkgtest [13:18:38]: test create-volume: - - - - - - - - - - results - - - - - - - - - - 321s create-volume PASS 322s autopkgtest [13:18:39]: @@@@@@@@@@@@@@@@@@@@ summary 322s smoke PASS (superficial) 322s create-volume PASS 340s flock: timeout while waiting to get lock 340s Creating nova instance adt-oracular-ppc64el-glusterfs-20240603-131315-juju-7f2275-prod-proposed-migration-environment-3-3dc3973e-e09f-46ea-a401-b7c2110962e7 from image adt/ubuntu-oracular-ppc64el-server-20240603.img (UUID 631d6369-5b04-4fc9-bdfe-727e63df0ef9)...