0s autopkgtest [13:59:02]: starting date and time: 2026-02-06 13:59:02+0000 0s autopkgtest [13:59:02]: git checkout: 4b346b80 nova: make wait_reboot return success even when a no-op 0s autopkgtest [13:59:02]: host juju-7f2275-prod-proposed-migration-environment-2; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.pbcd6bt2/out --timeout-copy=6000 --needs-internet=try --setup-commands /home/ubuntu/autopkgtest-cloud/worker-config-production/setup-canonical.sh --apt-pocket=proposed=src:python-cryptography --apt-upgrade zigpy --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 --env=ADT_TEST_TRIGGERS=python-cryptography/46.0.1-1ubuntu2 -- ssh -s /home/ubuntu/autopkgtest/ssh-setup/nova -- --flavor autopkgtest-cpu2-ram4-disk20-s390x --security-groups autopkgtest-juju-7f2275-prod-proposed-migration-environment-2@sto01-s390x-30.secgroup --name adt-resolute-s390x-zigpy-20260206-135902-juju-7f2275-prod-proposed-migration-environment-2-c2a7660b-0f87-4820-9024-2954e40dd778 --image adt/ubuntu-resolute-s390x-server --keyname testbed-juju-7f2275-prod-proposed-migration-environment-2 --net-id=net_prod-autopkgtest-workers-s390x -e TERM=linux --mirror=http://ftpmaster.internal/ubuntu/ 4s Creating nova instance adt-resolute-s390x-zigpy-20260206-135902-juju-7f2275-prod-proposed-migration-environment-2-c2a7660b-0f87-4820-9024-2954e40dd778 from image adt/ubuntu-resolute-s390x-server-20260205.img (UUID 269b3742-7045-4843-96ce-2a9dced91842)... 161s autopkgtest [14:01:43]: testbed dpkg architecture: s390x 162s autopkgtest [14:01:44]: testbed apt version: 3.1.14 163s autopkgtest [14:01:45]: @@@@@@@@@@@@@@@@@@@@ test bed setup 164s autopkgtest [14:01:46]: testbed release detected to be: None 166s autopkgtest [14:01:48]: updating testbed package index (apt update) 167s Get:1 http://ftpmaster.internal/ubuntu resolute-proposed InRelease [124 kB] 167s Hit:2 http://ftpmaster.internal/ubuntu resolute InRelease 167s Hit:3 http://ftpmaster.internal/ubuntu resolute-updates InRelease 167s Hit:4 http://ftpmaster.internal/ubuntu resolute-security InRelease 167s Get:5 http://ftpmaster.internal/ubuntu resolute-proposed/main Sources [191 kB] 167s Get:6 http://ftpmaster.internal/ubuntu resolute-proposed/universe Sources [1473 kB] 167s Get:7 http://ftpmaster.internal/ubuntu resolute-proposed/multiverse Sources [30.8 kB] 167s Get:8 http://ftpmaster.internal/ubuntu resolute-proposed/restricted Sources [9256 B] 167s Get:9 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x Packages [221 kB] 167s Get:10 http://ftpmaster.internal/ubuntu resolute-proposed/universe s390x Packages [1255 kB] 168s Get:11 http://ftpmaster.internal/ubuntu resolute-proposed/multiverse s390x Packages [7384 B] 171s Fetched 3312 kB in 5s (730 kB/s) 176s Reading package lists... 178s Hit:1 http://ftpmaster.internal/ubuntu resolute-proposed InRelease 178s Hit:2 http://ftpmaster.internal/ubuntu resolute InRelease 178s Hit:3 http://ftpmaster.internal/ubuntu resolute-updates InRelease 178s Hit:4 http://ftpmaster.internal/ubuntu resolute-security InRelease 183s Reading package lists... 183s Reading package lists... 184s Building dependency tree... 185s Reading state information... 186s Calculating upgrade... 187s The following packages will be REMOVED: 187s python3-openssl 187s The following packages will be upgraded: 187s apt busybox-initramfs busybox-static dmsetup findutils less libapt-pkg7.0 187s libattr1 libdevmapper1.02.1 libdrm-amdgpu1 libdrm-common libdrm2 libgpm2 187s libkeyutils1 libmaxminddb0 libnpth0t64 libsensors-config libsensors5 mawk 187s patch python3-cryptography python3-markdown-it tar 188s 23 upgraded, 0 newly installed, 1 to remove and 0 not upgraded. 188s Need to get 6407 kB of archives. 188s After this operation, 109 kB disk space will be freed. 188s Get:1 http://ftpmaster.internal/ubuntu resolute/main s390x findutils s390x 4.10.0-3build2 [314 kB] 188s Get:2 http://ftpmaster.internal/ubuntu resolute/main s390x tar s390x 1.35+dfsg-3.1build2 [271 kB] 188s Get:3 http://ftpmaster.internal/ubuntu resolute/main s390x libattr1 s390x 1:2.5.2-3build2 [11.8 kB] 188s Get:4 http://ftpmaster.internal/ubuntu resolute/main s390x mawk s390x 1.3.4.20260129-1 [136 kB] 188s Get:5 http://ftpmaster.internal/ubuntu resolute/main s390x libapt-pkg7.0 s390x 3.1.15 [1156 kB] 188s Get:6 http://ftpmaster.internal/ubuntu resolute/main s390x apt s390x 3.1.15 [1470 kB] 188s Get:7 http://ftpmaster.internal/ubuntu resolute/main s390x libdevmapper1.02.1 s390x 2:1.02.205-2ubuntu3 [143 kB] 188s Get:8 http://ftpmaster.internal/ubuntu resolute/main s390x dmsetup s390x 2:1.02.205-2ubuntu3 [79.7 kB] 188s Get:9 http://ftpmaster.internal/ubuntu resolute/main s390x less s390x 668-1build1 [182 kB] 188s Get:10 http://ftpmaster.internal/ubuntu resolute/main s390x libkeyutils1 s390x 1.6.3-6ubuntu3 [10.5 kB] 188s Get:11 http://ftpmaster.internal/ubuntu resolute/main s390x python3-markdown-it all 3.0.0-3build1 [54.4 kB] 188s Get:12 http://ftpmaster.internal/ubuntu resolute/main s390x busybox-static s390x 1:1.37.0-7ubuntu1 [997 kB] 188s Get:13 http://ftpmaster.internal/ubuntu resolute/main s390x libdrm-common all 2.4.131-1 [9774 B] 188s Get:14 http://ftpmaster.internal/ubuntu resolute/main s390x libdrm2 s390x 2.4.131-1 [44.6 kB] 188s Get:15 http://ftpmaster.internal/ubuntu resolute/main s390x libgpm2 s390x 1.20.7-12build1 [14.7 kB] 188s Get:16 http://ftpmaster.internal/ubuntu resolute/main s390x libmaxminddb0 s390x 1.12.2-1build2 [19.0 kB] 188s Get:17 http://ftpmaster.internal/ubuntu resolute/main s390x libsensors-config all 1:3.6.2-2build1 [6862 B] 188s Get:18 http://ftpmaster.internal/ubuntu resolute/main s390x libsensors5 s390x 1:3.6.2-2build1 [29.6 kB] 188s Get:19 http://ftpmaster.internal/ubuntu resolute/main s390x busybox-initramfs s390x 1:1.37.0-7ubuntu1 [195 kB] 188s Get:20 http://ftpmaster.internal/ubuntu resolute/main s390x libdrm-amdgpu1 s390x 2.4.131-1 [23.1 kB] 188s Get:21 http://ftpmaster.internal/ubuntu resolute/main s390x libnpth0t64 s390x 1.8-3build1 [8914 B] 188s Get:22 http://ftpmaster.internal/ubuntu resolute/main s390x patch s390x 2.8-2build1 [101 kB] 188s Get:23 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x python3-cryptography s390x 46.0.1-1ubuntu2 [1128 kB] 195s dpkg-preconfigure: unable to re-open stdin: No such file or directory 196s Fetched 6407 kB in 1s (6460 kB/s) 198s (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 ... 61954 files and directories currently installed.) 198s Preparing to unpack .../findutils_4.10.0-3build2_s390x.deb ... 199s Unpacking findutils (4.10.0-3build2) over (4.10.0-3build1) ... 201s Setting up findutils (4.10.0-3build2) ... 202s (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 ... 61954 files and directories currently installed.) 202s Preparing to unpack .../tar_1.35+dfsg-3.1build2_s390x.deb ... 202s Unpacking tar (1.35+dfsg-3.1build2) over (1.35+dfsg-3.1build1) ... 204s Setting up tar (1.35+dfsg-3.1build2) ... 205s (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 ... 61952 files and directories currently installed.) 205s Removing python3-openssl (25.1.0-1) ... 207s (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 ... 61937 files and directories currently installed.) 207s Preparing to unpack .../libattr1_1%3a2.5.2-3build2_s390x.deb ... 207s Unpacking libattr1:s390x (1:2.5.2-3build2) over (1:2.5.2-3build1) ... 207s Setting up libattr1:s390x (1:2.5.2-3build2) ... 208s (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 ... 61937 files and directories currently installed.) 208s Preparing to unpack .../00-mawk_1.3.4.20260129-1_s390x.deb ... 208s Unpacking mawk (1.3.4.20260129-1) over (1.3.4.20250131-2) ... 210s Preparing to unpack .../01-libapt-pkg7.0_3.1.15_s390x.deb ... 210s Unpacking libapt-pkg7.0:s390x (3.1.15) over (3.1.14) ... 215s Preparing to unpack .../02-apt_3.1.15_s390x.deb ... 215s Unpacking apt (3.1.15) over (3.1.14) ... 217s Preparing to unpack .../03-libdevmapper1.02.1_2%3a1.02.205-2ubuntu3_s390x.deb ... 217s Unpacking libdevmapper1.02.1:s390x (2:1.02.205-2ubuntu3) over (2:1.02.205-2ubuntu2) ... 218s Preparing to unpack .../04-dmsetup_2%3a1.02.205-2ubuntu3_s390x.deb ... 219s Unpacking dmsetup (2:1.02.205-2ubuntu3) over (2:1.02.205-2ubuntu2) ... 221s Preparing to unpack .../05-less_668-1build1_s390x.deb ... 224s Unpacking less (668-1build1) over (668-1) ... 230s Preparing to unpack .../06-libkeyutils1_1.6.3-6ubuntu3_s390x.deb ... 231s Unpacking libkeyutils1:s390x (1.6.3-6ubuntu3) over (1.6.3-6ubuntu2) ... 233s Preparing to unpack .../07-python3-markdown-it_3.0.0-3build1_all.deb ... 236s Unpacking python3-markdown-it (3.0.0-3build1) over (3.0.0-3) ... 237s Preparing to unpack .../08-busybox-static_1%3a1.37.0-7ubuntu1_s390x.deb ... 238s Unpacking busybox-static (1:1.37.0-7ubuntu1) over (1:1.37.0-4ubuntu1) ... 239s Preparing to unpack .../09-libdrm-common_2.4.131-1_all.deb ... 240s Unpacking libdrm-common (2.4.131-1) over (2.4.129-1) ... 243s Preparing to unpack .../10-libdrm2_2.4.131-1_s390x.deb ... 244s Unpacking libdrm2:s390x (2.4.131-1) over (2.4.129-1) ... 245s Preparing to unpack .../11-libgpm2_1.20.7-12build1_s390x.deb ... 246s Unpacking libgpm2:s390x (1.20.7-12build1) over (1.20.7-12) ... 246s Preparing to unpack .../12-libmaxminddb0_1.12.2-1build2_s390x.deb ... 246s Unpacking libmaxminddb0:s390x (1.12.2-1build2) over (1.12.2-1build1) ... 247s Preparing to unpack .../13-libsensors-config_1%3a3.6.2-2build1_all.deb ... 248s Unpacking libsensors-config (1:3.6.2-2build1) over (1:3.6.2-2) ... 249s Preparing to unpack .../14-libsensors5_1%3a3.6.2-2build1_s390x.deb ... 250s Unpacking libsensors5:s390x (1:3.6.2-2build1) over (1:3.6.2-2) ... 251s Preparing to unpack .../15-busybox-initramfs_1%3a1.37.0-7ubuntu1_s390x.deb ... 251s Unpacking busybox-initramfs (1:1.37.0-7ubuntu1) over (1:1.37.0-4ubuntu1) ... 253s Preparing to unpack .../16-libdrm-amdgpu1_2.4.131-1_s390x.deb ... 253s Unpacking libdrm-amdgpu1:s390x (2.4.131-1) over (2.4.129-1) ... 254s Preparing to unpack .../17-libnpth0t64_1.8-3build1_s390x.deb ... 254s Unpacking libnpth0t64:s390x (1.8-3build1) over (1.8-3) ... 255s Preparing to unpack .../18-patch_2.8-2build1_s390x.deb ... 257s Unpacking patch (2.8-2build1) over (2.8-2) ... 257s Preparing to unpack .../19-python3-cryptography_46.0.1-1ubuntu2_s390x.deb ... 257s Unpacking python3-cryptography (46.0.1-1ubuntu2) over (43.0.0-1ubuntu1) ... 260s Setting up libnpth0t64:s390x (1.8-3build1) ... 261s Setting up libkeyutils1:s390x (1.6.3-6ubuntu3) ... 261s Setting up libgpm2:s390x (1.20.7-12build1) ... 261s Setting up libmaxminddb0:s390x (1.12.2-1build2) ... 261s Setting up libsensors-config (1:3.6.2-2build1) ... 262s Setting up less (668-1build1) ... 263s Setting up busybox-static (1:1.37.0-7ubuntu1) ... 264s Setting up python3-cryptography (46.0.1-1ubuntu2) ... 268s Setting up patch (2.8-2build1) ... 268s Setting up libsensors5:s390x (1:3.6.2-2build1) ... 269s Setting up busybox-initramfs (1:1.37.0-7ubuntu1) ... 269s Setting up python3-markdown-it (3.0.0-3build1) ... 272s Setting up libdevmapper1.02.1:s390x (2:1.02.205-2ubuntu3) ... 272s Setting up dmsetup (2:1.02.205-2ubuntu3) ... 272s Setting up mawk (1.3.4.20260129-1) ... 272s Setting up libapt-pkg7.0:s390x (3.1.15) ... 273s Setting up libdrm-common (2.4.131-1) ... 274s Setting up apt (3.1.15) ... 280s Setting up libdrm2:s390x (2.4.131-1) ... 280s Setting up libdrm-amdgpu1:s390x (2.4.131-1) ... 282s Processing triggers for libc-bin (2.42-2ubuntu4) ... 284s Processing triggers for man-db (2.13.1-1) ... 334s Processing triggers for install-info (7.2-5) ... 337s Processing triggers for initramfs-tools (0.150ubuntu7) ... 338s update-initramfs: Generating /boot/initrd.img-6.18.0-9-generic 390s Using config file '/etc/zipl.conf' 391s Building bootmap in '/boot' 391s Adding IPL section 'ubuntu' (default) 392s Preparing boot device: vda. 393s Done. 395s autopkgtest [14:05:37]: upgrading testbed (apt dist-upgrade and autopurge) 403s Reading package lists... 405s Building dependency tree... 405s Reading state information... 406s Calculating upgrade... 408s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 409s Reading package lists... 410s Building dependency tree... 410s Reading state information... 411s Solving dependencies... 412s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 413s autopkgtest [14:05:55]: rebooting testbed after setup commands that affected boot 492s autopkgtest [14:07:14]: testbed running kernel: Linux 6.18.0-9-generic #9-Ubuntu SMP Mon Jan 12 15:39:23 UTC 2026 498s autopkgtest [14:07:20]: @@@@@@@@@@@@@@@@@@@@ apt-source zigpy 505s Get:1 http://ftpmaster.internal/ubuntu resolute/universe zigpy 0.90.0-1 (dsc) [2556 B] 505s Get:2 http://ftpmaster.internal/ubuntu resolute/universe zigpy 0.90.0-1 (tar) [499 kB] 505s Get:3 http://ftpmaster.internal/ubuntu resolute/universe zigpy 0.90.0-1 (diff) [3960 B] 509s gpgv: Signature made Fri Jan 9 11:48:30 2026 UTC 509s gpgv: using RSA key FB8ACFA78C726089C38AD0269605A1098C63B92A 509s gpgv: Can't check signature: No public key 509s dpkg-source: warning: cannot verify inline signature for ./zigpy_0.90.0-1.dsc: no acceptable signature found 510s autopkgtest [14:07:32]: testing package zigpy version 0.90.0-1 510s autopkgtest [14:07:32]: build not needed 511s autopkgtest [14:07:33]: test pybuild-autopkgtest: preparing testbed 513s Reading package lists... 514s Building dependency tree... 514s Reading state information... 514s Solving dependencies... 518s The following NEW packages will be installed: 518s autoconf automake autopoint autotools-dev build-essential cpp cpp-15 518s cpp-15-s390x-linux-gnu cpp-s390x-linux-gnu debhelper debugedit dh-autoreconf 518s dh-python dh-strip-nondeterminism dwz g++ g++-15 g++-15-s390x-linux-gnu 518s g++-s390x-linux-gnu gcc gcc-15 gcc-15-s390x-linux-gnu gcc-s390x-linux-gnu 518s gettext intltool-debian libarchive-zip-perl libasan8 libc-dev-bin libc6-dev 518s libcc1-0 libcrypt-dev libdebhelper-perl libfile-stripnondeterminism-perl 518s libgcc-15-dev libgomp1 libisl23 libitm1 liblsan0 libmpc3 518s libpython3.14-minimal libpython3.14-stdlib libstdc++-15-dev libtool libtsan2 518s libubsan1 linux-libc-dev m4 po-debconf pybuild-plugin-autopkgtest 518s pybuild-plugin-pyproject python3-aiohappyeyeballs python3-aiohttp 518s python3-aioresponses python3-aiosignal python3-aiosqlite python3-all 518s python3-async-timeout python3-build python3-crccheck python3-filelock 518s python3-freezegun python3-frozendict python3-frozenlist python3-iniconfig 518s python3-installer python3-multidict python3-pluggy python3-propcache 518s python3-pyproject-hooks python3-pyserial-asyncio-fast python3-pytest 518s python3-pytest-asyncio python3-voluptuous python3-wheel python3-yarl 518s python3-zigpy python3.14 python3.14-minimal rpcsvc-proto 518s 0 upgraded, 79 newly installed, 0 to remove and 0 not upgraded. 518s Need to get 72.2 MB of archives. 518s After this operation, 244 MB of additional disk space will be used. 518s Get:1 http://ftpmaster.internal/ubuntu resolute/main s390x libpython3.14-minimal s390x 3.14.2-1 [917 kB] 519s Get:2 http://ftpmaster.internal/ubuntu resolute/main s390x python3.14-minimal s390x 3.14.2-1 [2510 kB] 519s Get:3 http://ftpmaster.internal/ubuntu resolute/main s390x m4 s390x 1.4.20-2 [223 kB] 519s Get:4 http://ftpmaster.internal/ubuntu resolute/main s390x autoconf all 2.72-3.1ubuntu1 [384 kB] 519s Get:5 http://ftpmaster.internal/ubuntu resolute/main s390x autotools-dev all 20240727.1build1 [43.4 kB] 519s Get:6 http://ftpmaster.internal/ubuntu resolute/main s390x automake all 1:1.18.1-3build1 [582 kB] 519s Get:7 http://ftpmaster.internal/ubuntu resolute/main s390x autopoint all 0.23.2-1 [620 kB] 519s Get:8 http://ftpmaster.internal/ubuntu resolute/main s390x libc-dev-bin s390x 2.42-2ubuntu4 [22.9 kB] 519s Get:9 http://ftpmaster.internal/ubuntu resolute/main s390x linux-libc-dev s390x 6.18.0-9.9 [1854 kB] 519s Get:10 http://ftpmaster.internal/ubuntu resolute/main s390x libcrypt-dev s390x 1:4.5.1-1 [127 kB] 519s Get:11 http://ftpmaster.internal/ubuntu resolute/main s390x rpcsvc-proto s390x 1.4.3-1build1 [67.1 kB] 519s Get:12 http://ftpmaster.internal/ubuntu resolute/main s390x libc6-dev s390x 2.42-2ubuntu4 [1696 kB] 519s Get:13 http://ftpmaster.internal/ubuntu resolute/main s390x libisl23 s390x 0.27-1build1 [702 kB] 519s Get:14 http://ftpmaster.internal/ubuntu resolute/main s390x libmpc3 s390x 1.3.1-2 [57.4 kB] 519s Get:15 http://ftpmaster.internal/ubuntu resolute/main s390x cpp-15-s390x-linux-gnu s390x 15.2.0-12ubuntu1 [10.2 MB] 519s Get:16 http://ftpmaster.internal/ubuntu resolute/main s390x cpp-15 s390x 15.2.0-12ubuntu1 [1028 B] 519s Get:17 http://ftpmaster.internal/ubuntu resolute/main s390x cpp-s390x-linux-gnu s390x 4:15.2.0-4ubuntu1 [5746 B] 519s Get:18 http://ftpmaster.internal/ubuntu resolute/main s390x cpp s390x 4:15.2.0-4ubuntu1 [22.4 kB] 519s Get:19 http://ftpmaster.internal/ubuntu resolute/main s390x libcc1-0 s390x 15.2.0-12ubuntu1 [50.0 kB] 519s Get:20 http://ftpmaster.internal/ubuntu resolute/main s390x libgomp1 s390x 15.2.0-12ubuntu1 [154 kB] 519s Get:21 http://ftpmaster.internal/ubuntu resolute/main s390x libitm1 s390x 15.2.0-12ubuntu1 [30.9 kB] 519s Get:22 http://ftpmaster.internal/ubuntu resolute/main s390x libasan8 s390x 15.2.0-12ubuntu1 [2968 kB] 519s Get:23 http://ftpmaster.internal/ubuntu resolute/main s390x liblsan0 s390x 15.2.0-12ubuntu1 [1354 kB] 520s Get:24 http://ftpmaster.internal/ubuntu resolute/main s390x libtsan2 s390x 15.2.0-12ubuntu1 [2685 kB] 520s Get:25 http://ftpmaster.internal/ubuntu resolute/main s390x libubsan1 s390x 15.2.0-12ubuntu1 [1211 kB] 520s Get:26 http://ftpmaster.internal/ubuntu resolute/main s390x libgcc-15-dev s390x 15.2.0-12ubuntu1 [1294 kB] 520s Get:27 http://ftpmaster.internal/ubuntu resolute/main s390x gcc-15-s390x-linux-gnu s390x 15.2.0-12ubuntu1 [19.9 MB] 521s Get:28 http://ftpmaster.internal/ubuntu resolute/main s390x gcc-15 s390x 15.2.0-12ubuntu1 [519 kB] 521s Get:29 http://ftpmaster.internal/ubuntu resolute/main s390x gcc-s390x-linux-gnu s390x 4:15.2.0-4ubuntu1 [1208 B] 521s Get:30 http://ftpmaster.internal/ubuntu resolute/main s390x gcc s390x 4:15.2.0-4ubuntu1 [5018 B] 521s Get:31 http://ftpmaster.internal/ubuntu resolute/main s390x libstdc++-15-dev s390x 15.2.0-12ubuntu1 [2660 kB] 522s Get:32 http://ftpmaster.internal/ubuntu resolute/main s390x g++-15-s390x-linux-gnu s390x 15.2.0-12ubuntu1 [11.7 MB] 522s Get:33 http://ftpmaster.internal/ubuntu resolute/main s390x g++-15 s390x 15.2.0-12ubuntu1 [25.3 kB] 522s Get:34 http://ftpmaster.internal/ubuntu resolute/main s390x g++-s390x-linux-gnu s390x 4:15.2.0-4ubuntu1 [956 B] 522s Get:35 http://ftpmaster.internal/ubuntu resolute/main s390x g++ s390x 4:15.2.0-4ubuntu1 [1078 B] 522s Get:36 http://ftpmaster.internal/ubuntu resolute/main s390x build-essential s390x 12.12ubuntu2 [5258 B] 522s Get:37 http://ftpmaster.internal/ubuntu resolute/main s390x libdebhelper-perl all 13.28ubuntu1 [97.4 kB] 522s Get:38 http://ftpmaster.internal/ubuntu resolute/main s390x libtool all 2.5.4-9 [169 kB] 522s Get:39 http://ftpmaster.internal/ubuntu resolute/main s390x dh-autoreconf all 21+nmu1 [11.9 kB] 522s Get:40 http://ftpmaster.internal/ubuntu resolute/main s390x libarchive-zip-perl all 1.68-1 [90.2 kB] 522s Get:41 http://ftpmaster.internal/ubuntu resolute/main s390x libfile-stripnondeterminism-perl all 1.15.0-1build1 [20.6 kB] 522s Get:42 http://ftpmaster.internal/ubuntu resolute/main s390x dh-strip-nondeterminism all 1.15.0-1build1 [5110 B] 522s Get:43 http://ftpmaster.internal/ubuntu resolute/main s390x debugedit s390x 1:5.2-3build1 [52.7 kB] 522s Get:44 http://ftpmaster.internal/ubuntu resolute/main s390x dwz s390x 0.16-2build1 [121 kB] 522s Get:45 http://ftpmaster.internal/ubuntu resolute/main s390x gettext s390x 0.23.2-1 [1062 kB] 522s Get:46 http://ftpmaster.internal/ubuntu resolute/main s390x intltool-debian all 0.35.0+20060710.6build1 [24.1 kB] 522s Get:47 http://ftpmaster.internal/ubuntu resolute/main s390x po-debconf all 1.0.22 [215 kB] 522s Get:48 http://ftpmaster.internal/ubuntu resolute/main s390x debhelper all 13.28ubuntu1 [916 kB] 522s Get:49 http://ftpmaster.internal/ubuntu resolute/universe s390x dh-python all 7.20260125 [122 kB] 522s Get:50 http://ftpmaster.internal/ubuntu resolute/main s390x libpython3.14-stdlib s390x 3.14.2-1 [2373 kB] 522s Get:51 http://ftpmaster.internal/ubuntu resolute/universe s390x pybuild-plugin-autopkgtest all 7.20260125 [1744 B] 522s Get:52 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-pyproject-hooks all 1.2.0-1 [10.2 kB] 522s Get:53 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-wheel all 0.46.1-2 [22.1 kB] 522s Get:54 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-build all 1.2.2-5 [30.9 kB] 522s Get:55 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-installer all 0.7.0+dfsg1-3 [17.4 kB] 522s Get:56 http://ftpmaster.internal/ubuntu resolute/universe s390x pybuild-plugin-pyproject all 7.20260125 [1712 B] 522s Get:57 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-aiohappyeyeballs all 2.6.1-2 [11.1 kB] 522s Get:58 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-multidict s390x 6.4.3-1build1 [73.5 kB] 522s Get:59 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-propcache s390x 0.3.1-1build1 [56.4 kB] 522s Get:60 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-yarl s390x 1.22.0-1 [105 kB] 522s Get:61 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-async-timeout all 5.0.1-1 [6830 B] 522s Get:62 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-frozenlist s390x 1.8.0-2 [58.2 kB] 522s Get:63 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-aiosignal all 1.4.0-1 [5628 B] 522s Get:64 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-aiohttp s390x 3.13.1-1 [498 kB] 522s Get:65 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-aioresponses all 0.7.6-3 [11.0 kB] 522s Get:66 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-aiosqlite all 0.21.0-1 [14.2 kB] 522s Get:67 http://ftpmaster.internal/ubuntu resolute/main s390x python3.14 s390x 3.14.2-1 [816 kB] 522s Get:68 http://ftpmaster.internal/ubuntu resolute/main s390x python3-all s390x 3.13.9-3 [890 B] 522s Get:69 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-crccheck all 1.3.0-1build1 [19.2 kB] 523s Get:70 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-filelock all 3.20.3-1 [13.5 kB] 523s Get:71 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-freezegun all 1.5.1-1.2build1 [16.1 kB] 523s Get:72 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-frozendict all 2.4.6-1 [13.2 kB] 523s Get:73 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-iniconfig all 2.1.0-2 [6962 B] 523s Get:74 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-pluggy all 1.6.0-2 [21.1 kB] 523s Get:75 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-pyserial-asyncio-fast all 0.16-2 [10.9 kB] 523s Get:76 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-pytest all 9.0.2-2 [277 kB] 523s Get:77 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-pytest-asyncio all 1.3.0-1 [13.8 kB] 523s Get:78 http://ftpmaster.internal/ubuntu resolute/main s390x python3-voluptuous all 0.16.0-1 [45.6 kB] 523s Get:79 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-zigpy all 0.90.0-1 [156 kB] 527s Fetched 72.2 MB in 4s (16.0 MB/s) 527s Selecting previously unselected package libpython3.14-minimal:s390x. 530s (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 ... 61942 files and directories currently installed.) 530s Preparing to unpack .../00-libpython3.14-minimal_3.14.2-1_s390x.deb ... 530s Unpacking libpython3.14-minimal:s390x (3.14.2-1) ... 531s Selecting previously unselected package python3.14-minimal. 531s Preparing to unpack .../01-python3.14-minimal_3.14.2-1_s390x.deb ... 531s Unpacking python3.14-minimal (3.14.2-1) ... 532s Selecting previously unselected package m4. 532s Preparing to unpack .../02-m4_1.4.20-2_s390x.deb ... 532s Unpacking m4 (1.4.20-2) ... 532s Selecting previously unselected package autoconf. 532s Preparing to unpack .../03-autoconf_2.72-3.1ubuntu1_all.deb ... 532s Unpacking autoconf (2.72-3.1ubuntu1) ... 532s Selecting previously unselected package autotools-dev. 532s Preparing to unpack .../04-autotools-dev_20240727.1build1_all.deb ... 532s Unpacking autotools-dev (20240727.1build1) ... 532s Selecting previously unselected package automake. 532s Preparing to unpack .../05-automake_1%3a1.18.1-3build1_all.deb ... 532s Unpacking automake (1:1.18.1-3build1) ... 533s Selecting previously unselected package autopoint. 533s Preparing to unpack .../06-autopoint_0.23.2-1_all.deb ... 533s Unpacking autopoint (0.23.2-1) ... 533s Selecting previously unselected package libc-dev-bin. 533s Preparing to unpack .../07-libc-dev-bin_2.42-2ubuntu4_s390x.deb ... 533s Unpacking libc-dev-bin (2.42-2ubuntu4) ... 533s Selecting previously unselected package linux-libc-dev:s390x. 533s Preparing to unpack .../08-linux-libc-dev_6.18.0-9.9_s390x.deb ... 533s Unpacking linux-libc-dev:s390x (6.18.0-9.9) ... 534s Selecting previously unselected package libcrypt-dev:s390x. 534s Preparing to unpack .../09-libcrypt-dev_1%3a4.5.1-1_s390x.deb ... 534s Unpacking libcrypt-dev:s390x (1:4.5.1-1) ... 535s Selecting previously unselected package rpcsvc-proto. 535s Preparing to unpack .../10-rpcsvc-proto_1.4.3-1build1_s390x.deb ... 535s Unpacking rpcsvc-proto (1.4.3-1build1) ... 535s Selecting previously unselected package libc6-dev:s390x. 535s Preparing to unpack .../11-libc6-dev_2.42-2ubuntu4_s390x.deb ... 535s Unpacking libc6-dev:s390x (2.42-2ubuntu4) ... 535s Selecting previously unselected package libisl23:s390x. 535s Preparing to unpack .../12-libisl23_0.27-1build1_s390x.deb ... 535s Unpacking libisl23:s390x (0.27-1build1) ... 536s Selecting previously unselected package libmpc3:s390x. 536s Preparing to unpack .../13-libmpc3_1.3.1-2_s390x.deb ... 536s Unpacking libmpc3:s390x (1.3.1-2) ... 536s Selecting previously unselected package cpp-15-s390x-linux-gnu. 536s Preparing to unpack .../14-cpp-15-s390x-linux-gnu_15.2.0-12ubuntu1_s390x.deb ... 536s Unpacking cpp-15-s390x-linux-gnu (15.2.0-12ubuntu1) ... 538s Selecting previously unselected package cpp-15. 538s Preparing to unpack .../15-cpp-15_15.2.0-12ubuntu1_s390x.deb ... 538s Unpacking cpp-15 (15.2.0-12ubuntu1) ... 538s Selecting previously unselected package cpp-s390x-linux-gnu. 538s Preparing to unpack .../16-cpp-s390x-linux-gnu_4%3a15.2.0-4ubuntu1_s390x.deb ... 538s Unpacking cpp-s390x-linux-gnu (4:15.2.0-4ubuntu1) ... 538s Selecting previously unselected package cpp. 538s Preparing to unpack .../17-cpp_4%3a15.2.0-4ubuntu1_s390x.deb ... 538s Unpacking cpp (4:15.2.0-4ubuntu1) ... 538s Selecting previously unselected package libcc1-0:s390x. 538s Preparing to unpack .../18-libcc1-0_15.2.0-12ubuntu1_s390x.deb ... 538s Unpacking libcc1-0:s390x (15.2.0-12ubuntu1) ... 538s Selecting previously unselected package libgomp1:s390x. 538s Preparing to unpack .../19-libgomp1_15.2.0-12ubuntu1_s390x.deb ... 538s Unpacking libgomp1:s390x (15.2.0-12ubuntu1) ... 538s Selecting previously unselected package libitm1:s390x. 538s Preparing to unpack .../20-libitm1_15.2.0-12ubuntu1_s390x.deb ... 538s Unpacking libitm1:s390x (15.2.0-12ubuntu1) ... 538s Selecting previously unselected package libasan8:s390x. 538s Preparing to unpack .../21-libasan8_15.2.0-12ubuntu1_s390x.deb ... 538s Unpacking libasan8:s390x (15.2.0-12ubuntu1) ... 539s Selecting previously unselected package liblsan0:s390x. 539s Preparing to unpack .../22-liblsan0_15.2.0-12ubuntu1_s390x.deb ... 539s Unpacking liblsan0:s390x (15.2.0-12ubuntu1) ... 539s Selecting previously unselected package libtsan2:s390x. 539s Preparing to unpack .../23-libtsan2_15.2.0-12ubuntu1_s390x.deb ... 539s Unpacking libtsan2:s390x (15.2.0-12ubuntu1) ... 540s Selecting previously unselected package libubsan1:s390x. 540s Preparing to unpack .../24-libubsan1_15.2.0-12ubuntu1_s390x.deb ... 540s Unpacking libubsan1:s390x (15.2.0-12ubuntu1) ... 540s Selecting previously unselected package libgcc-15-dev:s390x. 540s Preparing to unpack .../25-libgcc-15-dev_15.2.0-12ubuntu1_s390x.deb ... 540s Unpacking libgcc-15-dev:s390x (15.2.0-12ubuntu1) ... 541s Selecting previously unselected package gcc-15-s390x-linux-gnu. 541s Preparing to unpack .../26-gcc-15-s390x-linux-gnu_15.2.0-12ubuntu1_s390x.deb ... 541s Unpacking gcc-15-s390x-linux-gnu (15.2.0-12ubuntu1) ... 544s Selecting previously unselected package gcc-15. 544s Preparing to unpack .../27-gcc-15_15.2.0-12ubuntu1_s390x.deb ... 544s Unpacking gcc-15 (15.2.0-12ubuntu1) ... 544s Selecting previously unselected package gcc-s390x-linux-gnu. 544s Preparing to unpack .../28-gcc-s390x-linux-gnu_4%3a15.2.0-4ubuntu1_s390x.deb ... 544s Unpacking gcc-s390x-linux-gnu (4:15.2.0-4ubuntu1) ... 544s Selecting previously unselected package gcc. 544s Preparing to unpack .../29-gcc_4%3a15.2.0-4ubuntu1_s390x.deb ... 544s Unpacking gcc (4:15.2.0-4ubuntu1) ... 544s Selecting previously unselected package libstdc++-15-dev:s390x. 544s Preparing to unpack .../30-libstdc++-15-dev_15.2.0-12ubuntu1_s390x.deb ... 544s Unpacking libstdc++-15-dev:s390x (15.2.0-12ubuntu1) ... 546s Selecting previously unselected package g++-15-s390x-linux-gnu. 546s Preparing to unpack .../31-g++-15-s390x-linux-gnu_15.2.0-12ubuntu1_s390x.deb ... 546s Unpacking g++-15-s390x-linux-gnu (15.2.0-12ubuntu1) ... 548s Selecting previously unselected package g++-15. 548s Preparing to unpack .../32-g++-15_15.2.0-12ubuntu1_s390x.deb ... 548s Unpacking g++-15 (15.2.0-12ubuntu1) ... 548s Selecting previously unselected package g++-s390x-linux-gnu. 548s Preparing to unpack .../33-g++-s390x-linux-gnu_4%3a15.2.0-4ubuntu1_s390x.deb ... 548s Unpacking g++-s390x-linux-gnu (4:15.2.0-4ubuntu1) ... 548s Selecting previously unselected package g++. 548s Preparing to unpack .../34-g++_4%3a15.2.0-4ubuntu1_s390x.deb ... 548s Unpacking g++ (4:15.2.0-4ubuntu1) ... 548s Selecting previously unselected package build-essential. 548s Preparing to unpack .../35-build-essential_12.12ubuntu2_s390x.deb ... 548s Unpacking build-essential (12.12ubuntu2) ... 548s Selecting previously unselected package libdebhelper-perl. 548s Preparing to unpack .../36-libdebhelper-perl_13.28ubuntu1_all.deb ... 548s Unpacking libdebhelper-perl (13.28ubuntu1) ... 548s Selecting previously unselected package libtool. 548s Preparing to unpack .../37-libtool_2.5.4-9_all.deb ... 548s Unpacking libtool (2.5.4-9) ... 549s Selecting previously unselected package dh-autoreconf. 549s Preparing to unpack .../38-dh-autoreconf_21+nmu1_all.deb ... 549s Unpacking dh-autoreconf (21+nmu1) ... 549s Selecting previously unselected package libarchive-zip-perl. 549s Preparing to unpack .../39-libarchive-zip-perl_1.68-1_all.deb ... 549s Unpacking libarchive-zip-perl (1.68-1) ... 549s Selecting previously unselected package libfile-stripnondeterminism-perl. 549s Preparing to unpack .../40-libfile-stripnondeterminism-perl_1.15.0-1build1_all.deb ... 549s Unpacking libfile-stripnondeterminism-perl (1.15.0-1build1) ... 549s Selecting previously unselected package dh-strip-nondeterminism. 549s Preparing to unpack .../41-dh-strip-nondeterminism_1.15.0-1build1_all.deb ... 549s Unpacking dh-strip-nondeterminism (1.15.0-1build1) ... 549s Selecting previously unselected package debugedit. 549s Preparing to unpack .../42-debugedit_1%3a5.2-3build1_s390x.deb ... 549s Unpacking debugedit (1:5.2-3build1) ... 549s Selecting previously unselected package dwz. 549s Preparing to unpack .../43-dwz_0.16-2build1_s390x.deb ... 549s Unpacking dwz (0.16-2build1) ... 549s Selecting previously unselected package gettext. 549s Preparing to unpack .../44-gettext_0.23.2-1_s390x.deb ... 549s Unpacking gettext (0.23.2-1) ... 550s Selecting previously unselected package intltool-debian. 550s Preparing to unpack .../45-intltool-debian_0.35.0+20060710.6build1_all.deb ... 550s Unpacking intltool-debian (0.35.0+20060710.6build1) ... 550s Selecting previously unselected package po-debconf. 550s Preparing to unpack .../46-po-debconf_1.0.22_all.deb ... 550s Unpacking po-debconf (1.0.22) ... 550s Selecting previously unselected package debhelper. 550s Preparing to unpack .../47-debhelper_13.28ubuntu1_all.deb ... 550s Unpacking debhelper (13.28ubuntu1) ... 551s Selecting previously unselected package dh-python. 551s Preparing to unpack .../48-dh-python_7.20260125_all.deb ... 551s Unpacking dh-python (7.20260125) ... 551s Selecting previously unselected package libpython3.14-stdlib:s390x. 551s Preparing to unpack .../49-libpython3.14-stdlib_3.14.2-1_s390x.deb ... 551s Unpacking libpython3.14-stdlib:s390x (3.14.2-1) ... 551s Selecting previously unselected package pybuild-plugin-autopkgtest. 551s Preparing to unpack .../50-pybuild-plugin-autopkgtest_7.20260125_all.deb ... 551s Unpacking pybuild-plugin-autopkgtest (7.20260125) ... 552s Selecting previously unselected package python3-pyproject-hooks. 552s Preparing to unpack .../51-python3-pyproject-hooks_1.2.0-1_all.deb ... 552s Unpacking python3-pyproject-hooks (1.2.0-1) ... 552s Selecting previously unselected package python3-wheel. 552s Preparing to unpack .../52-python3-wheel_0.46.1-2_all.deb ... 552s Unpacking python3-wheel (0.46.1-2) ... 552s Selecting previously unselected package python3-build. 552s Preparing to unpack .../53-python3-build_1.2.2-5_all.deb ... 552s Unpacking python3-build (1.2.2-5) ... 552s Selecting previously unselected package python3-installer. 552s Preparing to unpack .../54-python3-installer_0.7.0+dfsg1-3_all.deb ... 552s Unpacking python3-installer (0.7.0+dfsg1-3) ... 552s Selecting previously unselected package pybuild-plugin-pyproject. 552s Preparing to unpack .../55-pybuild-plugin-pyproject_7.20260125_all.deb ... 552s Unpacking pybuild-plugin-pyproject (7.20260125) ... 552s Selecting previously unselected package python3-aiohappyeyeballs. 552s Preparing to unpack .../56-python3-aiohappyeyeballs_2.6.1-2_all.deb ... 552s Unpacking python3-aiohappyeyeballs (2.6.1-2) ... 552s Selecting previously unselected package python3-multidict. 552s Preparing to unpack .../57-python3-multidict_6.4.3-1build1_s390x.deb ... 552s Unpacking python3-multidict (6.4.3-1build1) ... 552s Selecting previously unselected package python3-propcache. 552s Preparing to unpack .../58-python3-propcache_0.3.1-1build1_s390x.deb ... 552s Unpacking python3-propcache (0.3.1-1build1) ... 552s Selecting previously unselected package python3-yarl. 552s Preparing to unpack .../59-python3-yarl_1.22.0-1_s390x.deb ... 552s Unpacking python3-yarl (1.22.0-1) ... 552s Selecting previously unselected package python3-async-timeout. 552s Preparing to unpack .../60-python3-async-timeout_5.0.1-1_all.deb ... 552s Unpacking python3-async-timeout (5.0.1-1) ... 552s Selecting previously unselected package python3-frozenlist. 552s Preparing to unpack .../61-python3-frozenlist_1.8.0-2_s390x.deb ... 552s Unpacking python3-frozenlist (1.8.0-2) ... 552s Selecting previously unselected package python3-aiosignal. 553s Preparing to unpack .../62-python3-aiosignal_1.4.0-1_all.deb ... 553s Unpacking python3-aiosignal (1.4.0-1) ... 553s Selecting previously unselected package python3-aiohttp. 553s Preparing to unpack .../63-python3-aiohttp_3.13.1-1_s390x.deb ... 553s Unpacking python3-aiohttp (3.13.1-1) ... 553s Selecting previously unselected package python3-aioresponses. 553s Preparing to unpack .../64-python3-aioresponses_0.7.6-3_all.deb ... 553s Unpacking python3-aioresponses (0.7.6-3) ... 553s Selecting previously unselected package python3-aiosqlite. 553s Preparing to unpack .../65-python3-aiosqlite_0.21.0-1_all.deb ... 553s Unpacking python3-aiosqlite (0.21.0-1) ... 553s Selecting previously unselected package python3.14. 554s Preparing to unpack .../66-python3.14_3.14.2-1_s390x.deb ... 554s Unpacking python3.14 (3.14.2-1) ... 554s Selecting previously unselected package python3-all. 554s Preparing to unpack .../67-python3-all_3.13.9-3_s390x.deb ... 554s Unpacking python3-all (3.13.9-3) ... 554s Selecting previously unselected package python3-crccheck. 554s Preparing to unpack .../68-python3-crccheck_1.3.0-1build1_all.deb ... 554s Unpacking python3-crccheck (1.3.0-1build1) ... 554s Selecting previously unselected package python3-filelock. 554s Preparing to unpack .../69-python3-filelock_3.20.3-1_all.deb ... 554s Unpacking python3-filelock (3.20.3-1) ... 554s Selecting previously unselected package python3-freezegun. 554s Preparing to unpack .../70-python3-freezegun_1.5.1-1.2build1_all.deb ... 554s Unpacking python3-freezegun (1.5.1-1.2build1) ... 555s Selecting previously unselected package python3-frozendict. 555s Preparing to unpack .../71-python3-frozendict_2.4.6-1_all.deb ... 555s Unpacking python3-frozendict (2.4.6-1) ... 555s Selecting previously unselected package python3-iniconfig. 555s Preparing to unpack .../72-python3-iniconfig_2.1.0-2_all.deb ... 555s Unpacking python3-iniconfig (2.1.0-2) ... 555s Selecting previously unselected package python3-pluggy. 555s Preparing to unpack .../73-python3-pluggy_1.6.0-2_all.deb ... 555s Unpacking python3-pluggy (1.6.0-2) ... 555s Selecting previously unselected package python3-pyserial-asyncio-fast. 555s Preparing to unpack .../74-python3-pyserial-asyncio-fast_0.16-2_all.deb ... 555s Unpacking python3-pyserial-asyncio-fast (0.16-2) ... 555s Selecting previously unselected package python3-pytest. 555s Preparing to unpack .../75-python3-pytest_9.0.2-2_all.deb ... 555s Unpacking python3-pytest (9.0.2-2) ... 555s Selecting previously unselected package python3-pytest-asyncio. 555s Preparing to unpack .../76-python3-pytest-asyncio_1.3.0-1_all.deb ... 555s Unpacking python3-pytest-asyncio (1.3.0-1) ... 555s Selecting previously unselected package python3-voluptuous. 555s Preparing to unpack .../77-python3-voluptuous_0.16.0-1_all.deb ... 555s Unpacking python3-voluptuous (0.16.0-1) ... 556s Selecting previously unselected package python3-zigpy. 556s Preparing to unpack .../78-python3-zigpy_0.90.0-1_all.deb ... 556s Unpacking python3-zigpy (0.90.0-1) ... 556s Setting up dh-python (7.20260125) ... 557s Setting up python3-iniconfig (2.1.0-2) ... 560s Setting up python3-filelock (3.20.3-1) ... 561s Setting up libarchive-zip-perl (1.68-1) ... 561s Setting up libdebhelper-perl (13.28ubuntu1) ... 561s Setting up libpython3.14-minimal:s390x (3.14.2-1) ... 561s Setting up python3-frozendict (2.4.6-1) ... 562s Setting up linux-libc-dev:s390x (6.18.0-9.9) ... 562s Setting up m4 (1.4.20-2) ... 562s Setting up libgomp1:s390x (15.2.0-12ubuntu1) ... 562s Setting up python3-wheel (0.46.1-2) ... 564s Setting up python3-multidict (6.4.3-1build1) ... 565s Setting up python3-frozenlist (1.8.0-2) ... 566s Setting up python3-aiosignal (1.4.0-1) ... 568s Setting up python3-async-timeout (5.0.1-1) ... 569s Setting up autotools-dev (20240727.1build1) ... 569s Setting up rpcsvc-proto (1.4.3-1build1) ... 569s Setting up python3-pyproject-hooks (1.2.0-1) ... 570s Setting up python3-aiosqlite (0.21.0-1) ... 572s Setting up libmpc3:s390x (1.3.1-2) ... 572s Setting up autopoint (0.23.2-1) ... 572s Setting up python3-aiohappyeyeballs (2.6.1-2) ... 573s Setting up python3-installer (0.7.0+dfsg1-3) ... 575s Setting up autoconf (2.72-3.1ubuntu1) ... 576s Setting up python3-pluggy (1.6.0-2) ... 576s Setting up libubsan1:s390x (15.2.0-12ubuntu1) ... 576s Setting up python3-pyserial-asyncio-fast (0.16-2) ... 577s Setting up dwz (0.16-2build1) ... 577s Setting up python3-propcache (0.3.1-1build1) ... 580s Setting up libcrypt-dev:s390x (1:4.5.1-1) ... 580s Setting up libasan8:s390x (15.2.0-12ubuntu1) ... 580s Setting up debugedit (1:5.2-3build1) ... 580s Setting up python3-crccheck (1.3.0-1build1) ... 581s Setting up python3-voluptuous (0.16.0-1) ... 583s Setting up libtsan2:s390x (15.2.0-12ubuntu1) ... 583s Setting up libisl23:s390x (0.27-1build1) ... 583s Setting up python3-build (1.2.2-5) ... 584s Setting up libc-dev-bin (2.42-2ubuntu4) ... 584s Setting up python3-yarl (1.22.0-1) ... 585s Setting up python3.14-minimal (3.14.2-1) ... 591s Setting up libcc1-0:s390x (15.2.0-12ubuntu1) ... 591s Setting up python3-freezegun (1.5.1-1.2build1) ... 593s Setting up liblsan0:s390x (15.2.0-12ubuntu1) ... 593s Setting up libitm1:s390x (15.2.0-12ubuntu1) ... 593s Setting up automake (1:1.18.1-3build1) ... 594s update-alternatives: using /usr/bin/automake-1.18 to provide /usr/bin/automake (automake) in auto mode 594s Setting up libfile-stripnondeterminism-perl (1.15.0-1build1) ... 594s Setting up gettext (0.23.2-1) ... 594s Setting up libgcc-15-dev:s390x (15.2.0-12ubuntu1) ... 594s Setting up libpython3.14-stdlib:s390x (3.14.2-1) ... 594s Setting up pybuild-plugin-pyproject (7.20260125) ... 594s Setting up python3-pytest (9.0.2-2) ... 599s Setting up python3-aiohttp (3.13.1-1) ... 603s Setting up python3-zigpy (0.90.0-1) ... 608s Setting up intltool-debian (0.35.0+20060710.6build1) ... 608s Setting up python3-pytest-asyncio (1.3.0-1) ... 609s Setting up dh-strip-nondeterminism (1.15.0-1build1) ... 609s Setting up cpp-15-s390x-linux-gnu (15.2.0-12ubuntu1) ... 609s Setting up libc6-dev:s390x (2.42-2ubuntu4) ... 609s Setting up python3.14 (3.14.2-1) ... 617s Setting up gcc-15-s390x-linux-gnu (15.2.0-12ubuntu1) ... 617s Setting up python3-aioresponses (0.7.6-3) ... 617s Setting up cpp-s390x-linux-gnu (4:15.2.0-4ubuntu1) ... 617s Setting up po-debconf (1.0.22) ... 617s Setting up python3-all (3.13.9-3) ... 617s Setting up libstdc++-15-dev:s390x (15.2.0-12ubuntu1) ... 617s Setting up gcc-s390x-linux-gnu (4:15.2.0-4ubuntu1) ... 617s Setting up cpp-15 (15.2.0-12ubuntu1) ... 617s Setting up cpp (4:15.2.0-4ubuntu1) ... 617s Setting up g++-15-s390x-linux-gnu (15.2.0-12ubuntu1) ... 617s Setting up g++-s390x-linux-gnu (4:15.2.0-4ubuntu1) ... 617s Setting up gcc-15 (15.2.0-12ubuntu1) ... 617s Setting up g++-15 (15.2.0-12ubuntu1) ... 617s Setting up libtool (2.5.4-9) ... 617s Setting up gcc (4:15.2.0-4ubuntu1) ... 617s Setting up dh-autoreconf (21+nmu1) ... 617s Setting up g++ (4:15.2.0-4ubuntu1) ... 617s update-alternatives: using /usr/bin/g++ to provide /usr/bin/c++ (c++) in auto mode 617s Setting up build-essential (12.12ubuntu2) ... 617s Setting up debhelper (13.28ubuntu1) ... 617s Setting up pybuild-plugin-autopkgtest (7.20260125) ... 617s Processing triggers for man-db (2.13.1-1) ... 656s Processing triggers for install-info (7.2-5) ... 658s Processing triggers for libc-bin (2.42-2ubuntu4) ... 660s Processing triggers for systemd (259-1ubuntu3) ... 665s autopkgtest [14:10:07]: test pybuild-autopkgtest: pybuild-autopkgtest 665s autopkgtest [14:10:07]: test pybuild-autopkgtest: [----------------------- 669s pybuild-autopkgtest 671s I: pybuild base:384: cd /tmp/autopkgtest.3V6GwJ/autopkgtest_tmp/build; python3.14 -m pytest -k "not test_quirks_v2 and not test_encrypted_telink_container and not test_telink_ota_image_serialize_bad_length" --ignore=tests/ota/test_ota_providers.py 708s ============================= test session starts ============================== 708s platform linux -- Python 3.14.2, pytest-9.0.2, pluggy-1.6.0 708s rootdir: /tmp/autopkgtest.3V6GwJ/autopkgtest_tmp/build 708s configfile: pyproject.toml 708s plugins: asyncio-1.3.0, typeguard-4.4.4 708s asyncio: mode=Mode.AUTO, debug=False, asyncio_default_fixture_loop_scope=function, asyncio_default_test_loop_scope=function 708s collected 995 items / 68 deselected / 927 selected 708s 764s tests/ota/test_ota_config.py ......F. [ 0%] 764s tests/ota/test_ota_image.py ......................... [ 3%] 774s tests/ota/test_ota_manager.py ...... [ 4%] 774s tests/ota/test_ota_matching.py ..... [ 4%] 774s tests/ota/test_ota_metadata.py .... [ 5%] 774s tests/ota/test_ota_validators.py ........... [ 6%] 774s tests/test_app_state.py ......... [ 7%] 796s tests/test_appdb.py ................................ [ 10%] 901s tests/test_appdb_migration.py ...................... [ 13%] 902s tests/test_application.py .............................................. [ 18%] 907s ........................................................ [ 24%] 907s tests/test_backups.py .......... [ 25%] 908s tests/test_config.py ................................................ [ 30%] 912s tests/test_datastructures.py .........F............... [ 33%] 912s tests/test_datastructures_cpython.py .............. [ 34%] 922s tests/test_device.py ................................................... [ 40%] 922s .. [ 40%] 924s tests/test_endpoint.py ................................................. [ 45%] 925s ....................... [ 48%] 925s tests/test_event.py ....... [ 48%] 925s tests/test_group.py ..................... [ 51%] 925s tests/test_listeners.py ........ [ 51%] 926s tests/test_packet_callbacks.py ......... [ 52%] 927s tests/test_quirks.py ........................... [ 55%] 927s tests/test_quirks_registry.py ..... [ 56%] 927s tests/test_serial.py ............. [ 57%] 928s tests/test_struct.py ........................................... [ 62%] 937s tests/test_topology.py ................ [ 64%] 938s tests/test_types.py .................................................... [ 69%] 938s ................. [ 71%] 940s tests/test_zcl.py ...................................................... [ 77%] 941s ...................................... [ 81%] 941s tests/test_zcl_clusters.py ....................................... [ 85%] 941s tests/test_zcl_foundation.py ........................................... [ 90%] 941s [ 90%] 942s tests/test_zdo.py ....................... [ 92%] 943s tests/test_zdo_types.py ....................... [ 95%] 949s tests/test_zigbee_util.py ........................................... [100%] 949s 949s =================================== FAILURES =================================== 949s ___________________________ test_ota_broadcast_loop ____________________________ 949s 949s async def test_ota_broadcast_loop() -> None: 949s app = make_app( 949s { 949s config.CONF_OTA: { 949s config.CONF_OTA_ENABLED: True, 949s config.CONF_OTA_BROADCAST_ENABLED: True, 949s config.CONF_OTA_BROADCAST_INITIAL_DELAY: 0.1, 949s config.CONF_OTA_BROADCAST_INTERVAL: 0.2, 949s } 949s } 949s ) 949s 949s with patch.object( 949s app.ota, 949s "broadcast_notify", 949s side_effect=[None, None, RuntimeError(), None, None, None], 949s ) as mock_broadcast_notify: 949s await app.startup() 949s assert app.ota._broadcast_loop_task is not None 949s await asyncio.sleep(1) 949s await app.shutdown() 949s 949s assert app.ota._broadcast_loop_task is None 949s > assert len(mock_broadcast_notify.mock_calls) == 5 949s E AssertionError: assert 4 == 5 949s E + where 4 = len([call(), call(), call(), call()]) 949s E + where [call(), call(), call(), call()] = .mock_calls 949s 949s tests/ota/test_ota_config.py:256: AssertionError 949s ------------------------------ Captured log setup ------------------------------ 949s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 949s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 949s ------------------------------ Captured log call ------------------------------- 949s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: ZigpyOtaProvider(url='https://raw.githubusercontent.com/zigpy/zigpy-ota/release/version/stable.json', channel='stable', manufacturer_ids=()) 949s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Ledvance(url='https://api.update.ledvance.com/v1/zigbee/firmwares', manufacturer_ids=(4489, 4364)) 949s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Sonoff(url=None, manufacturer_ids=(4742,)) 949s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Inovelli(url=None, manufacturer_ids=(4655,)) 949s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: ThirdReality(url=None, manufacturer_ids=(4659, 4877, 5127)) 949s DEBUG zigpy.application:application.py:795 Feeding watchdog 949s DEBUG zigpy.application:application.py:238 Network info: NetworkInfo(extended_pan_id=ff:ff:ff:ff:ff:ff:ff:ff, pan_id=0xFFFE, nwk_update_id=0, nwk_manager_id=0x0000, channel=15, channel_mask=, security_level=0, network_key=Key(key=ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), tc_link_key=Key(key=5a:69:67:42:65:65:41:6c:6c:69:61:6e:63:65:30:39, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), key_table=[], children=[], route_table={}, tx_power=None, nwk_addresses={}, stack_specific={}, metadata={}, source=None) 949s DEBUG zigpy.application:application.py:239 Node info: NodeInfo(nwk=0x0000, ieee=aa:11:22:bb:33:44:be:ef, logical_type=, model=None, manufacturer=None, version=None) 949s DEBUG zigpy.application:application.py:198 No TX power configured, using radio default 949s DEBUG zigpy.application:application.py:598 Device is initialized 949s DEBUG zigpy.quirks.registry:registry.py:108 Checking quirks for Coordinator Manufacturer Coordinator Model (aa:11:22:bb:33:44:be:ef) 949s DEBUG zigpy.application:application.py:804 Starting watchdog loop 949s DEBUG zigpy.backups:backups.py:200 Adding a new backup NetworkBackup(version=1, backup_time=datetime.datetime(2026, 2, 6, 14, 13, 59, 751069, tzinfo=datetime.timezone.utc), network_info=NetworkInfo(extended_pan_id=ff:ff:ff:ff:ff:ff:ff:ff, pan_id=0xFFFE, nwk_update_id=0, nwk_manager_id=0x0000, channel=15, channel_mask=, security_level=0, network_key=Key(key=ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), tc_link_key=Key(key=5a:69:67:42:65:65:41:6c:6c:69:61:6e:63:65:30:39, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), key_table=[], children=[], route_table={}, tx_power=None, nwk_addresses={}, stack_specific={}, metadata={}, source=None), node_info=NodeInfo(nwk=0x0000, ieee=aa:11:22:bb:33:44:be:ef, logical_type=, model=None, manufacturer=None, version=None)) 949s DEBUG zigpy.backups:backups.py:203 Backup is incomplete, ignoring 949s DEBUG zigpy.backups:backups.py:240 Waiting for 86400s before backing up again 949s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 949s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 949s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 949s DEBUG zigpy.ota:__init__.py:243 OTA broadcast failed 949s Traceback (most recent call last): 949s File "/usr/lib/python3/dist-packages/zigpy/ota/__init__.py", line 241, in broadcast_loop 949s await self.broadcast_notify() 949s File "/usr/lib/python3.14/unittest/mock.py", line 2335, in _execute_mock_call 949s raise result 949s RuntimeError 949s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 949s ____________________ test_reschedulable_timeout_reschedule _____________________ 949s 949s async def test_reschedulable_timeout_reschedule(): 949s callback = Mock() 949s timeout = datastructures.ReschedulableTimeout(callback) 949s 949s timeout.reschedule(0.1) 949s timeout.reschedule(0.2) 949s await asyncio.sleep(0.19) 949s > assert len(callback.mock_calls) == 0 949s E AssertionError: assert 1 == 0 949s E + where 1 = len([call()]) 949s E + where [call()] = .mock_calls 949s 949s tests/test_datastructures.py:360: AssertionError 949s ------------------------------ Captured log setup ------------------------------ 949s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 949s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 949s =============================== warnings summary =============================== 949s tests/test_application.py::test_startup_tx_power_config[App-config_override5-8] 949s tests/test_application.py::test_startup_tx_power_config[App-config_override6-10] 949s tests/test_application.py::test_startup_tx_power_config[FeaturelessApp-config_override7-15] 949s tests/test_application.py::test_startup_tx_power_config[FeaturelessApp-config_override8-15] 949s /usr/lib/python3/dist-packages/voluptuous/schema_builder.py:804: UserWarning: Increasing the TX power will not increase the range of your network, devices still need to be able to respond to your coordinator and will do so at their default transmit power. Changing the TX power may cause routing issues and result in end devices being unable to join reliably. Modify this setting at your own risk and check local regulations for legal limits on transmit power in your area. 949s return schema(data) 949s 949s -- Docs: https://docs.pytest.org/en/stable/how-to/capture-warnings.html 949s =========================== short test summary info ============================ 949s FAILED tests/ota/test_ota_config.py::test_ota_broadcast_loop - AssertionError... 949s FAILED tests/test_datastructures.py::test_reschedulable_timeout_reschedule - ... 949s ===== 2 failed, 925 passed, 68 deselected, 4 warnings in 263.08s (0:04:23) ===== 951s E: pybuild pybuild:483: test: plugin pyproject failed with: exit code=1: cd /tmp/autopkgtest.3V6GwJ/autopkgtest_tmp/build; python3.14 -m pytest -k "not test_quirks_v2 and not test_encrypted_telink_container and not test_telink_ota_image_serialize_bad_length" --ignore=tests/ota/test_ota_providers.py 951s I: pybuild base:384: cd /tmp/autopkgtest.3V6GwJ/autopkgtest_tmp/build; python3.13 -m pytest -k "not test_quirks_v2 and not test_encrypted_telink_container and not test_telink_ota_image_serialize_bad_length" --ignore=tests/ota/test_ota_providers.py 978s ============================= test session starts ============================== 978s platform linux -- Python 3.13.11, pytest-9.0.2, pluggy-1.6.0 978s rootdir: /tmp/autopkgtest.3V6GwJ/autopkgtest_tmp/build 978s configfile: pyproject.toml 978s plugins: asyncio-1.3.0, typeguard-4.4.4 978s asyncio: mode=Mode.AUTO, debug=False, asyncio_default_fixture_loop_scope=function, asyncio_default_test_loop_scope=function 978s collected 995 items / 68 deselected / 927 selected 978s 1034s tests/ota/test_ota_config.py ......F. [ 0%] 1034s tests/ota/test_ota_image.py ......................... [ 3%] 1043s tests/ota/test_ota_manager.py ...... [ 4%] 1044s tests/ota/test_ota_matching.py ..... [ 4%] 1044s tests/ota/test_ota_metadata.py .... [ 5%] 1044s tests/ota/test_ota_validators.py ........... [ 6%] 1044s tests/test_app_state.py ......... [ 7%] 1075s tests/test_appdb.py ................................ [ 10%] 1189s tests/test_appdb_migration.py ...................... [ 13%] 1190s tests/test_application.py .............................................. [ 18%] 1196s ........................................................ [ 24%] 1196s tests/test_backups.py .......... [ 25%] 1196s tests/test_config.py ................................................ [ 30%] 1199s tests/test_datastructures.py ........F....F........... [ 33%] 1200s tests/test_datastructures_cpython.py .............. [ 34%] 1208s tests/test_device.py ................................................... [ 40%] 1209s .. [ 40%] 1210s tests/test_endpoint.py ................................................. [ 45%] 1211s ....................... [ 48%] 1211s tests/test_event.py ....... [ 48%] 1212s tests/test_group.py ..................... [ 51%] 1212s tests/test_listeners.py ........ [ 51%] 1212s tests/test_packet_callbacks.py ......... [ 52%] 1214s tests/test_quirks.py ........................... [ 55%] 1214s tests/test_quirks_registry.py ..... [ 56%] 1214s tests/test_serial.py ............. [ 57%] 1214s tests/test_struct.py ........................................... [ 62%] 1223s tests/test_topology.py ...............F [ 64%] 1224s tests/test_types.py .................................................... [ 69%] 1224s ................. [ 71%] 1226s tests/test_zcl.py ...................................................... [ 77%] 1227s ...................................... [ 81%] 1228s tests/test_zcl_clusters.py ....................................... [ 85%] 1228s tests/test_zcl_foundation.py ........................................... [ 90%] 1228s [ 90%] 1229s tests/test_zdo.py ....................... [ 92%] 1229s tests/test_zdo_types.py ....................... [ 95%] 1233s tests/test_zigbee_util.py ........................................... [100%] 1233s 1233s =================================== FAILURES =================================== 1233s ___________________________ test_ota_broadcast_loop ____________________________ 1233s 1233s async def test_ota_broadcast_loop() -> None: 1233s app = make_app( 1233s { 1233s config.CONF_OTA: { 1233s config.CONF_OTA_ENABLED: True, 1233s config.CONF_OTA_BROADCAST_ENABLED: True, 1233s config.CONF_OTA_BROADCAST_INITIAL_DELAY: 0.1, 1233s config.CONF_OTA_BROADCAST_INTERVAL: 0.2, 1233s } 1233s } 1233s ) 1233s 1233s with patch.object( 1233s app.ota, 1233s "broadcast_notify", 1233s side_effect=[None, None, RuntimeError(), None, None, None], 1233s ) as mock_broadcast_notify: 1233s await app.startup() 1233s assert app.ota._broadcast_loop_task is not None 1233s await asyncio.sleep(1) 1233s await app.shutdown() 1233s 1233s assert app.ota._broadcast_loop_task is None 1233s > assert len(mock_broadcast_notify.mock_calls) == 5 1233s E AssertionError: assert 4 == 5 1233s E + where 4 = len([call(), call(), call(), call()]) 1233s E + where [call(), call(), call(), call()] = .mock_calls 1233s 1233s tests/ota/test_ota_config.py:256: AssertionError 1233s ------------------------------ Captured log setup ------------------------------ 1233s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1233s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1233s ------------------------------ Captured log call ------------------------------- 1233s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: ZigpyOtaProvider(url='https://raw.githubusercontent.com/zigpy/zigpy-ota/release/version/stable.json', channel='stable', manufacturer_ids=()) 1233s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Ledvance(url='https://api.update.ledvance.com/v1/zigbee/firmwares', manufacturer_ids=(4489, 4364)) 1233s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Sonoff(url=None, manufacturer_ids=(4742,)) 1233s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Inovelli(url=None, manufacturer_ids=(4655,)) 1233s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: ThirdReality(url=None, manufacturer_ids=(4659, 4877, 5127)) 1233s DEBUG zigpy.application:application.py:795 Feeding watchdog 1233s DEBUG zigpy.application:application.py:238 Network info: NetworkInfo(extended_pan_id=ff:ff:ff:ff:ff:ff:ff:ff, pan_id=0xFFFE, nwk_update_id=0, nwk_manager_id=0x0000, channel=15, channel_mask=, security_level=0, network_key=Key(key=ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), tc_link_key=Key(key=5a:69:67:42:65:65:41:6c:6c:69:61:6e:63:65:30:39, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), key_table=[], children=[], route_table={}, tx_power=None, nwk_addresses={}, stack_specific={}, metadata={}, source=None) 1233s DEBUG zigpy.application:application.py:239 Node info: NodeInfo(nwk=0x0000, ieee=aa:11:22:bb:33:44:be:ef, logical_type=, model=None, manufacturer=None, version=None) 1233s DEBUG zigpy.application:application.py:198 No TX power configured, using radio default 1233s DEBUG zigpy.application:application.py:598 Device is initialized 1233s DEBUG zigpy.quirks.registry:registry.py:108 Checking quirks for Coordinator Manufacturer Coordinator Model (aa:11:22:bb:33:44:be:ef) 1233s DEBUG zigpy.application:application.py:804 Starting watchdog loop 1233s DEBUG zigpy.backups:backups.py:200 Adding a new backup NetworkBackup(version=1, backup_time=datetime.datetime(2026, 2, 6, 14, 18, 29, 769492, tzinfo=datetime.timezone.utc), network_info=NetworkInfo(extended_pan_id=ff:ff:ff:ff:ff:ff:ff:ff, pan_id=0xFFFE, nwk_update_id=0, nwk_manager_id=0x0000, channel=15, channel_mask=, security_level=0, network_key=Key(key=ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff:ff, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), tc_link_key=Key(key=5a:69:67:42:65:65:41:6c:6c:69:61:6e:63:65:30:39, tx_counter=0, rx_counter=0, seq=0, partner_ieee=ff:ff:ff:ff:ff:ff:ff:ff), key_table=[], children=[], route_table={}, tx_power=None, nwk_addresses={}, stack_specific={}, metadata={}, source=None), node_info=NodeInfo(nwk=0x0000, ieee=aa:11:22:bb:33:44:be:ef, logical_type=, model=None, manufacturer=None, version=None)) 1233s DEBUG zigpy.backups:backups.py:203 Backup is incomplete, ignoring 1233s DEBUG zigpy.backups:backups.py:240 Waiting for 86400s before backing up again 1233s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 1233s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 1233s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 1233s DEBUG zigpy.ota:__init__.py:243 OTA broadcast failed 1233s Traceback (most recent call last): 1233s File "/usr/lib/python3/dist-packages/zigpy/ota/__init__.py", line 241, in broadcast_loop 1233s await self.broadcast_notify() 1233s File "/usr/lib/python3.13/unittest/mock.py", line 2330, in _execute_mock_call 1233s raise result 1233s RuntimeError 1233s DEBUG zigpy.ota:__init__.py:238 Broadcasting OTA notification 1233s __________________________ test_reschedulable_timeout __________________________ 1233s 1233s async def test_reschedulable_timeout(): 1233s callback = Mock() 1233s timeout = datastructures.ReschedulableTimeout(callback) 1233s 1233s timeout.reschedule(0.1) 1233s assert len(callback.mock_calls) == 0 1233s await asyncio.sleep(0.09) 1233s > assert len(callback.mock_calls) == 0 1233s E AssertionError: assert 1 == 0 1233s E + where 1 = len([call()]) 1233s E + where [call()] = .mock_calls 1233s 1233s tests/test_datastructures.py:348: AssertionError 1233s ------------------------------ Captured log setup ------------------------------ 1233s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1233s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1233s _________________________ test_debouncer_cleaning_bug __________________________ 1233s 1233s async def test_debouncer_cleaning_bug(): 1233s """Test debouncer bug when using heapq improperly.""" 1233s debouncer = datastructures.Debouncer() 1233s 1233s obj1 = object() 1233s obj2 = object() 1233s obj3 = object() 1233s 1233s # Filter obj1 with an expiration of 0.3 seconds 1233s debouncer.filter(obj1, expire_in=0.3) 1233s 1233s # Slight delay to ensure different expiration times 1233s await asyncio.sleep(0.05) 1233s 1233s # Filter obj2 with an expiration of 0.1 seconds 1233s debouncer.filter(obj2, expire_in=0.1) 1233s 1233s # Another slight delay 1233s await asyncio.sleep(0.05) 1233s 1233s # Filter obj3 with an expiration of 0.2 seconds 1233s debouncer.filter(obj3, expire_in=0.2) 1233s 1233s assert debouncer.is_filtered(obj1) 1233s assert debouncer.is_filtered(obj2) 1233s assert debouncer.is_filtered(obj3) 1233s 1233s # Wait until after obj2 should have expired 1233s await asyncio.sleep(0.11) # Total elapsed time ~0.21 seconds from start 1233s 1233s # Clean up expired items 1233s debouncer.clean() 1233s 1233s # obj2 should have expired, but due to the bug, it might still be filtered 1233s assert not debouncer.is_filtered(obj2) 1233s 1233s # obj1 and obj3 should still be filtered 1233s > assert debouncer.is_filtered(obj1) 1233s E assert False 1233s E + where False = is_filtered() 1233s E + where is_filtered = .is_filtered 1233s 1233s tests/test_datastructures.py:478: AssertionError 1233s ------------------------------ Captured log setup ------------------------------ 1233s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1233s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1233s _________________________ test_periodic_scan_priority __________________________ 1233s 1233s topology = 1233s 1233s async def test_periodic_scan_priority(topology): 1233s async def _scan(_): 1234s await asyncio.sleep(0.5) 1234s 1234s with mock.patch.object(topology, "_scan", side_effect=_scan) as mock_scan: 1234s scan_task = asyncio.create_task(topology.scan()) 1234s await asyncio.sleep(0.1) 1234s 1234s # Start a periodic scan. It won't have time to run yet, the old scan is running 1234s topology.start_periodic_scans(0.05) 1234s 1234s # Wait for the original scan to finish 1234s await scan_task 1234s 1234s # Start another scan, interrupting the periodic scan 1234s await asyncio.sleep(0.15) 1234s await topology.scan() 1234s 1234s # Now we can cancel the periodic scan 1234s topology.stop_periodic_scans() 1234s await asyncio.sleep(0) 1234s 1234s # Our two manual scans succeeded and the periodic one was attempted 1234s > assert len(mock_scan.mock_calls) == 3 1234s E AssertionError: assert 4 == 3 1234s E + where 4 = len([call(None), call(None), call(None), call(None)]) 1234s E + where [call(None), call(None), call(None), call(None)] = .mock_calls 1234s 1234s tests/test_topology.py:419: AssertionError 1234s ------------------------------ Captured log setup ------------------------------ 1234s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1234s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: ZigpyOtaProvider(url='https://raw.githubusercontent.com/zigpy/zigpy-ota/release/version/stable.json', channel='stable', manufacturer_ids=()) 1234s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Ledvance(url='https://api.update.ledvance.com/v1/zigbee/firmwares', manufacturer_ids=(4489, 4364)) 1234s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Sonoff(url=None, manufacturer_ids=(4742,)) 1234s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: Inovelli(url=None, manufacturer_ids=(4655,)) 1234s DEBUG zigpy.ota:__init__.py:363 Registering new OTA provider: ThirdReality(url=None, manufacturer_ids=(4659, 4877, 5127)) 1234s DEBUG asyncio:selector_events.py:64 Using selector: EpollSelector 1234s ------------------------------ Captured log call ------------------------------- 1234s DEBUG zigpy.topology:topology.py:75 Starting scheduled neighbor scan 1234s DEBUG zigpy.topology:topology.py:92 Cancelling old scanning task 1234s DEBUG zigpy.topology:topology.py:82 Topology scan cancelled 1234s DEBUG zigpy.topology:topology.py:75 Starting scheduled neighbor scan 1234s DEBUG zigpy.topology:topology.py:82 Topology scan cancelled 1234s =============================== warnings summary =============================== 1234s tests/test_application.py::test_startup_tx_power_config[App-config_override5-8] 1234s tests/test_application.py::test_startup_tx_power_config[App-config_override6-10] 1234s tests/test_application.py::test_startup_tx_power_config[FeaturelessApp-config_override7-15] 1234s tests/test_application.py::test_startup_tx_power_config[FeaturelessApp-config_override8-15] 1234s /usr/lib/python3/dist-packages/voluptuous/schema_builder.py:804: UserWarning: Increasing the TX power will not increase the range of your network, devices still need to be able to respond to your coordinator and will do so at their default transmit power. Changing the TX power may cause routing issues and result in end devices being unable to join reliably. Modify this setting at your own risk and check local regulations for legal limits on transmit power in your area. 1234s return schema(data) 1234s 1234s -- Docs: https://docs.pytest.org/en/stable/how-to/capture-warnings.html 1234s =========================== short test summary info ============================ 1234s FAILED tests/ota/test_ota_config.py::test_ota_broadcast_loop - AssertionError... 1234s FAILED tests/test_datastructures.py::test_reschedulable_timeout - AssertionEr... 1234s FAILED tests/test_datastructures.py::test_debouncer_cleaning_bug - assert False 1234s FAILED tests/test_topology.py::test_periodic_scan_priority - AssertionError: ... 1234s ===== 4 failed, 923 passed, 68 deselected, 4 warnings in 275.81s (0:04:35) ===== 1235s E: pybuild pybuild:483: test: plugin pyproject failed with: exit code=1: cd /tmp/autopkgtest.3V6GwJ/autopkgtest_tmp/build; python3.13 -m pytest -k "not test_quirks_v2 and not test_encrypted_telink_container and not test_telink_ota_image_serialize_bad_length" --ignore=tests/ota/test_ota_providers.py 1235s pybuild-autopkgtest: error: pybuild --autopkgtest --test-pytest -i python{version} -p "3.14 3.13" returned exit code 13 1235s make: *** [/tmp/8TEbjsc41k/run:4: pybuild-autopkgtest] Error 25 1235s pybuild-autopkgtest: error: /tmp/8TEbjsc41k/run pybuild-autopkgtest returned exit code 2 1236s autopkgtest [14:19:38]: test pybuild-autopkgtest: -----------------------] 1237s pybuild-autopkgtest FAIL non-zero exit status 25 1237s autopkgtest [14:19:39]: test pybuild-autopkgtest: - - - - - - - - - - results - - - - - - - - - - 1238s autopkgtest [14:19:40]: @@@@@@@@@@@@@@@@@@@@ summary 1238s pybuild-autopkgtest FAIL non-zero exit status 25