2026-01-26 03:14:11.686273 | Job console starting 2026-01-26 03:14:11.728380 | Updating git repos 2026-01-26 03:14:11.776404 | Cloning repos into workspace 2026-01-26 03:14:11.869514 | Restoring repo states 2026-01-26 03:14:11.879687 | Merging changes 2026-01-26 03:14:11.879707 | Checking out repos 2026-01-26 03:14:11.935000 | Preparing playbooks 2026-01-26 03:14:12.664243 | Running Ansible setup 2026-01-26 03:14:17.498296 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-01-26 03:14:18.352449 | 2026-01-26 03:14:18.352624 | PLAY [Base pre] 2026-01-26 03:14:18.387986 | 2026-01-26 03:14:18.388195 | TASK [Setup log path fact] 2026-01-26 03:14:18.431219 | debian-bookworm | ok 2026-01-26 03:14:18.466376 | 2026-01-26 03:14:18.466568 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-01-26 03:14:18.513283 | debian-bookworm | ok 2026-01-26 03:14:18.534512 | 2026-01-26 03:14:18.534663 | TASK [emit-job-header : Print job information] 2026-01-26 03:14:18.608365 | # Job Information 2026-01-26 03:14:18.608571 | Ansible Version: 2.16.14 2026-01-26 03:14:18.608606 | Job: tox 2026-01-26 03:14:18.608638 | Pipeline: periodic-daily 2026-01-26 03:14:18.608661 | Executor: 521e9411259a 2026-01-26 03:14:18.608681 | Triggered by: https://github.com/osism/openstack-image-manager 2026-01-26 03:14:18.608703 | Event ID: 951f2c3ac17a4ec78aa313780e0cbdd9 2026-01-26 03:14:18.616448 | 2026-01-26 03:14:18.616590 | LOOP [emit-job-header : Print node information] 2026-01-26 03:14:18.796329 | debian-bookworm | ok: 2026-01-26 03:14:18.796545 | debian-bookworm | # Node Information 2026-01-26 03:14:18.796588 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-01-26 03:14:18.796620 | debian-bookworm | Hostname: debian 2026-01-26 03:14:18.796648 | debian-bookworm | Username: zuul 2026-01-26 03:14:18.796675 | debian-bookworm | Distro: Debian 12.13 2026-01-26 03:14:18.796706 | debian-bookworm | Provider: regiocloud-a 2026-01-26 03:14:18.796734 | debian-bookworm | Region: 2026-01-26 03:14:18.796761 | debian-bookworm | Label: debian-bookworm 2026-01-26 03:14:18.796788 | debian-bookworm | Product Name: OpenStack Nova 2026-01-26 03:14:18.796814 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe15:49ab 2026-01-26 03:14:18.829481 | 2026-01-26 03:14:18.829647 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-01-26 03:14:19.537486 | debian-bookworm -> localhost | changed 2026-01-26 03:14:19.559270 | 2026-01-26 03:14:19.559571 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-01-26 03:14:21.736461 | debian-bookworm -> localhost | changed 2026-01-26 03:14:21.748040 | 2026-01-26 03:14:21.748171 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-01-26 03:14:22.111193 | debian-bookworm -> localhost | ok 2026-01-26 03:14:22.119587 | 2026-01-26 03:14:22.119727 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-01-26 03:14:22.153387 | debian-bookworm | ok 2026-01-26 03:14:22.198542 | debian-bookworm | included: /var/lib/zuul/builds/72d9c0e63978488f85cff58070f944e6/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-01-26 03:14:22.205276 | 2026-01-26 03:14:22.205397 | TASK [add-build-sshkey : Create Temp SSH key] 2026-01-26 03:14:24.488982 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-01-26 03:14:24.489225 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/72d9c0e63978488f85cff58070f944e6/work/72d9c0e63978488f85cff58070f944e6_id_rsa 2026-01-26 03:14:24.489265 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/72d9c0e63978488f85cff58070f944e6/work/72d9c0e63978488f85cff58070f944e6_id_rsa.pub 2026-01-26 03:14:24.489292 | debian-bookworm -> localhost | The key fingerprint is: 2026-01-26 03:14:24.489319 | debian-bookworm -> localhost | SHA256:PipbnjDvwPFGl8ij7CPijCPdPd4/zwclfMEKv3+Yybo zuul-build-sshkey 2026-01-26 03:14:24.489342 | debian-bookworm -> localhost | The key's randomart image is: 2026-01-26 03:14:24.489378 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-01-26 03:14:24.489402 | debian-bookworm -> localhost | | . | 2026-01-26 03:14:24.489426 | debian-bookworm -> localhost | | . o | 2026-01-26 03:14:24.489449 | debian-bookworm -> localhost | | + . . | 2026-01-26 03:14:24.489470 | debian-bookworm -> localhost | | . . . = o | 2026-01-26 03:14:24.489493 | debian-bookworm -> localhost | | . = S = | 2026-01-26 03:14:24.489527 | debian-bookworm -> localhost | | o = + o | 2026-01-26 03:14:24.489549 | debian-bookworm -> localhost | | . .B.+ o + + | 2026-01-26 03:14:24.489571 | debian-bookworm -> localhost | |* o.+Oo+ ... B .| 2026-01-26 03:14:24.489593 | debian-bookworm -> localhost | |+= .o*B....oE+ . | 2026-01-26 03:14:24.489616 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-01-26 03:14:24.489676 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.299652 2026-01-26 03:14:24.502088 | 2026-01-26 03:14:24.503027 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-01-26 03:14:24.557807 | debian-bookworm | ok 2026-01-26 03:14:24.573048 | debian-bookworm | included: /var/lib/zuul/builds/72d9c0e63978488f85cff58070f944e6/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-01-26 03:14:24.592660 | 2026-01-26 03:14:24.592814 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-01-26 03:14:24.618912 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:14:24.625638 | 2026-01-26 03:14:24.625755 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-01-26 03:14:25.417387 | debian-bookworm | changed 2026-01-26 03:14:25.424574 | 2026-01-26 03:14:25.424674 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-01-26 03:14:25.674749 | debian-bookworm | ok 2026-01-26 03:14:25.680402 | 2026-01-26 03:14:25.680503 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-01-26 03:14:26.360333 | debian-bookworm | changed 2026-01-26 03:14:26.370976 | 2026-01-26 03:14:26.371115 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-01-26 03:14:27.017788 | debian-bookworm | changed 2026-01-26 03:14:27.027023 | 2026-01-26 03:14:27.027127 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-01-26 03:14:27.041089 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:14:27.048105 | 2026-01-26 03:14:27.048203 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-01-26 03:14:27.455772 | debian-bookworm -> localhost | changed 2026-01-26 03:14:27.479905 | 2026-01-26 03:14:27.480093 | TASK [add-build-sshkey : Add back temp key] 2026-01-26 03:14:27.849115 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/72d9c0e63978488f85cff58070f944e6/work/72d9c0e63978488f85cff58070f944e6_id_rsa (zuul-build-sshkey) 2026-01-26 03:14:27.849316 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.012095 2026-01-26 03:14:27.857090 | 2026-01-26 03:14:27.857178 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-01-26 03:14:28.274796 | debian-bookworm | ok 2026-01-26 03:14:28.283520 | 2026-01-26 03:14:28.283612 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-01-26 03:14:28.317341 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:14:28.329783 | 2026-01-26 03:14:28.329916 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-01-26 03:14:28.764922 | debian-bookworm | ok 2026-01-26 03:14:28.775574 | 2026-01-26 03:14:28.775668 | TASK [validate-host : Define zuul_info_dir fact] 2026-01-26 03:14:28.803815 | debian-bookworm | ok 2026-01-26 03:14:28.808728 | 2026-01-26 03:14:28.808821 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-01-26 03:14:29.104564 | debian-bookworm -> localhost | ok 2026-01-26 03:14:29.113888 | 2026-01-26 03:14:29.113986 | TASK [validate-host : Collect information about the host] 2026-01-26 03:14:30.301218 | debian-bookworm | ok 2026-01-26 03:14:30.315516 | 2026-01-26 03:14:30.315673 | TASK [validate-host : Sanitize hostname] 2026-01-26 03:14:30.436560 | debian-bookworm | ok 2026-01-26 03:14:30.469603 | 2026-01-26 03:14:30.469710 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-01-26 03:14:31.024562 | debian-bookworm -> localhost | changed 2026-01-26 03:14:31.030195 | 2026-01-26 03:14:31.030295 | TASK [validate-host : Collect information about zuul worker] 2026-01-26 03:14:31.455732 | debian-bookworm | ok 2026-01-26 03:14:31.468844 | 2026-01-26 03:14:31.468964 | TASK [validate-host : Write out all zuul information for each host] 2026-01-26 03:14:32.105183 | debian-bookworm -> localhost | changed 2026-01-26 03:14:32.116984 | 2026-01-26 03:14:32.117107 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-01-26 03:14:32.414792 | debian-bookworm | ok 2026-01-26 03:14:32.420924 | 2026-01-26 03:14:32.421013 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-01-26 03:14:33.731539 | debian-bookworm | changed: 2026-01-26 03:14:33.731718 | debian-bookworm | cd+++++++++ src/ 2026-01-26 03:14:33.731752 | debian-bookworm | cd+++++++++ src/github.com/ 2026-01-26 03:14:33.731776 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-01-26 03:14:33.731797 | debian-bookworm | cd+++++++++ src/github.com/osism/openstack-image-manager/ 2026-01-26 03:14:33.731817 | debian-bookworm | =6.2.4 2026-01-26 03:14:58.458416 | debian-bookworm | Downloading cachetools-6.2.5-py3-none-any.whl (11 kB) 2026-01-26 03:14:58.493505 | debian-bookworm | Collecting chardet>=5.2 2026-01-26 03:14:58.506374 | debian-bookworm | Downloading chardet-5.2.0-py3-none-any.whl (199 kB) 2026-01-26 03:14:58.517604 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 199.4/199.4 kB 24.2 MB/s eta 0:00:00 2026-01-26 03:14:58.555261 | debian-bookworm | Collecting colorama>=0.4.6 2026-01-26 03:14:58.568193 | debian-bookworm | Downloading colorama-0.4.6-py2.py3-none-any.whl (25 kB) 2026-01-26 03:14:58.626243 | debian-bookworm | Collecting filelock>=3.20.2 2026-01-26 03:14:58.639266 | debian-bookworm | Downloading filelock-3.20.3-py3-none-any.whl (16 kB) 2026-01-26 03:14:58.700346 | debian-bookworm | Collecting packaging>=25 2026-01-26 03:14:58.714244 | debian-bookworm | Downloading packaging-26.0-py3-none-any.whl (74 kB) 2026-01-26 03:14:58.723722 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 74.4/74.4 kB 11.1 MB/s eta 0:00:00 2026-01-26 03:14:58.772472 | debian-bookworm | Collecting platformdirs>=4.5.1 2026-01-26 03:14:58.788300 | debian-bookworm | Downloading platformdirs-4.5.1-py3-none-any.whl (18 kB) 2026-01-26 03:14:58.854770 | debian-bookworm | Collecting pluggy>=1.6 2026-01-26 03:14:58.868955 | debian-bookworm | Downloading pluggy-1.6.0-py3-none-any.whl (20 kB) 2026-01-26 03:14:58.929542 | debian-bookworm | Collecting pyproject-api>=1.10 2026-01-26 03:14:58.945978 | debian-bookworm | Downloading pyproject_api-1.10.0-py3-none-any.whl (13 kB) 2026-01-26 03:14:59.114426 | debian-bookworm | Collecting virtualenv>=20.35.4 2026-01-26 03:14:59.128015 | debian-bookworm | Downloading virtualenv-20.36.1-py3-none-any.whl (6.0 MB) 2026-01-26 03:14:59.298621 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 6.0/6.0 MB 36.2 MB/s eta 0:00:00 2026-01-26 03:14:59.399818 | debian-bookworm | Collecting distlib<1,>=0.3.7 2026-01-26 03:14:59.412557 | debian-bookworm | Downloading distlib-0.4.0-py2.py3-none-any.whl (469 kB) 2026-01-26 03:14:59.457732 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 469.0/469.0 kB 11.7 MB/s eta 0:00:00 2026-01-26 03:14:59.617405 | debian-bookworm | Installing collected packages: distlib, pluggy, platformdirs, packaging, filelock, colorama, chardet, cachetools, virtualenv, pyproject-api, tox 2026-01-26 03:15:00.616426 | debian-bookworm | Successfully installed cachetools-6.2.5 chardet-5.2.0 colorama-0.4.6 distlib-0.4.0 filelock-3.20.3 packaging-26.0 platformdirs-4.5.1 pluggy-1.6.0 pyproject-api-1.10.0 tox-4.34.1 virtualenv-20.36.1 2026-01-26 03:15:01.240616 | debian-bookworm | ok: Runtime: 0:00:03.171151 2026-01-26 03:15:01.247138 | 2026-01-26 03:15:01.247234 | TASK [ensure-tox : Export installed tox_executable path] 2026-01-26 03:15:01.350635 | debian-bookworm | ok 2026-01-26 03:15:01.391448 | 2026-01-26 03:15:01.393589 | TASK [ensure-tox : Output tox version] 2026-01-26 03:15:01.981157 | debian-bookworm | ROOT: No loadable tox.ini or setup.cfg or pyproject.toml or tox.toml found, assuming empty tox.ini at /home/zuul 2026-01-26 03:15:01.999781 | debian-bookworm | 4.34.1 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2026-01-26 03:15:02.456305 | debian-bookworm | ok: Runtime: 0:00:00.313679 2026-01-26 03:15:02.464175 | 2026-01-26 03:15:02.464334 | TASK [ensure-tox : Make global symlink] 2026-01-26 03:15:02.549275 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:02.558387 | 2026-01-26 03:15:02.558464 | PLAY RECAP 2026-01-26 03:15:02.558532 | debian-bookworm | ok: 13 changed: 9 unreachable: 0 failed: 0 skipped: 14 rescued: 0 ignored: 0 2026-01-26 03:15:02.558558 | 2026-01-26 03:15:02.995982 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/pre.yaml@master] 2026-01-26 03:15:02.997106 | RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2026-01-26 03:15:04.791521 | 2026-01-26 03:15:04.791716 | PLAY [all] 2026-01-26 03:15:04.811494 | 2026-01-26 03:15:04.811595 | TASK [revoke-sudo : Check if zuul is sudoer] 2026-01-26 03:15:05.339271 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2026-01-26 03:15:05.844413 | debian-bookworm | ok: Runtime: 0:00:00.022281 2026-01-26 03:15:05.850028 | 2026-01-26 03:15:05.850155 | TASK [revoke-sudo : Remove sudo access for zuul user.] 2026-01-26 03:15:06.410099 | debian-bookworm | ok: Runtime: 0:00:00.007480 2026-01-26 03:15:06.417930 | 2026-01-26 03:15:06.418029 | TASK [revoke-sudo : Prove that general sudo access is actually revoked.] 2026-01-26 03:15:06.801780 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2026-01-26 03:15:06.804930 | debian-bookworm | sudo: a password is required 2026-01-26 03:15:06.983252 | debian-bookworm | ok: Runtime: 0:00:00.023236 2026-01-26 03:15:06.993756 | 2026-01-26 03:15:06.993875 | TASK [tox : Check to see if the constraints file exists] 2026-01-26 03:15:07.023267 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:07.029611 | 2026-01-26 03:15:07.029705 | TASK [tox : Fail if constraints file is missing] 2026-01-26 03:15:07.053087 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:07.059616 | 2026-01-26 03:15:07.059701 | TASK [tox : Record file location] 2026-01-26 03:15:07.083037 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:07.088300 | 2026-01-26 03:15:07.088388 | TASK [tox : Install tox siblings] 2026-01-26 03:15:07.128236 | debian-bookworm | ok 2026-01-26 03:15:07.136023 | debian-bookworm | included: /var/lib/zuul/builds/72d9c0e63978488f85cff58070f944e6/untrusted/project_0/github.com/osism/openinfra-zuul-jobs/roles/tox/tasks/siblings.yaml 2026-01-26 03:15:07.141667 | 2026-01-26 03:15:07.141749 | TASK [tox : Run tox without tests] 2026-01-26 03:15:08.311327 | debian-bookworm | test: install_deps> python -I -m pip install -r requirements.txt 2026-01-26 03:15:24.333950 | debian-bookworm | test: OK (16.63 seconds) 2026-01-26 03:15:24.334035 | debian-bookworm | congratulations :) (16.66 seconds) 2026-01-26 03:15:24.679215 | debian-bookworm | ok: Runtime: 0:00:16.958076 2026-01-26 03:15:24.684659 | 2026-01-26 03:15:24.684747 | TASK [tox : Create a tempfile to save tox showconfig] 2026-01-26 03:15:25.129689 | debian-bookworm | changed 2026-01-26 03:15:25.134778 | 2026-01-26 03:15:25.137953 | TASK [tox : Get tox envlist config] 2026-01-26 03:15:26.192439 | debian-bookworm | ok: Runtime: 0:00:00.343025 2026-01-26 03:15:26.197843 | 2026-01-26 03:15:26.197932 | TASK [tox : Install any sibling python packages] 2026-01-26 03:15:26.730140 | debian-bookworm | ok: No setup.cfg, no action needed 2026-01-26 03:15:26.737722 | 2026-01-26 03:15:26.737840 | TASK [tox : Remove tempfile] 2026-01-26 03:15:27.205632 | debian-bookworm | changed 2026-01-26 03:15:27.212921 | 2026-01-26 03:15:27.213036 | TASK [tox : Emit tox command] 2026-01-26 03:15:27.261297 | /home/zuul/.local/tox/bin/tox -etest -- test/unit 2026-01-26 03:15:27.266621 | 2026-01-26 03:15:27.266713 | TASK [tox : Run tox] 2026-01-26 03:15:27.878651 | debian-bookworm | test: commands[0]> python -m unittest discover test/unit 2026-01-26 03:15:28.507588 | debian-bookworm | ............... 2026-01-26 03:15:28.508147 | debian-bookworm | ---------------------------------------------------------------------- 2026-01-26 03:15:28.508170 | debian-bookworm | Ran 15 tests in 0.171s 2026-01-26 03:15:28.508176 | debian-bookworm | 2026-01-26 03:15:28.508184 | debian-bookworm | OK 2026-01-26 03:15:28.595052 | debian-bookworm | test: OK (0.76=setup[0.04]+cmd[0.71] seconds) 2026-01-26 03:15:28.595115 | debian-bookworm | congratulations :) (0.79 seconds) 2026-01-26 03:15:28.819935 | debian-bookworm | ok: Runtime: 0:00:01.081789 2026-01-26 03:15:28.826718 | 2026-01-26 03:15:28.826849 | TASK [tox : Look for output] 2026-01-26 03:15:29.351461 | debian-bookworm | ok 2026-01-26 03:15:29.377512 | 2026-01-26 03:15:29.377668 | TASK [tox : Return file comments to Zuul] 2026-01-26 03:15:29.476886 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:29.491028 | 2026-01-26 03:15:29.491143 | PLAY RECAP 2026-01-26 03:15:29.491202 | debian-bookworm | ok: 12 changed: 8 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 0 2026-01-26 03:15:29.491228 | 2026-01-26 03:15:29.916640 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2026-01-26 03:15:29.917476 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2026-01-26 03:15:31.092541 | 2026-01-26 03:15:31.092677 | PLAY [all] 2026-01-26 03:15:31.109591 | 2026-01-26 03:15:31.109768 | TASK [fetch-tox-output : Set tox log path for multiple nodes] 2026-01-26 03:15:31.245583 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:31.252335 | 2026-01-26 03:15:31.252495 | TASK [fetch-tox-output : Set tox log path for single node] 2026-01-26 03:15:31.321038 | debian-bookworm | ok 2026-01-26 03:15:31.326622 | 2026-01-26 03:15:31.326742 | TASK [fetch-tox-output : Ensure local tox dir] 2026-01-26 03:15:32.129835 | debian-bookworm -> localhost | changed 2026-01-26 03:15:32.137539 | 2026-01-26 03:15:32.137646 | TASK [fetch-tox-output : Ensure zuul-output tox dir] 2026-01-26 03:15:32.211758 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:32.218408 | 2026-01-26 03:15:32.218513 | TASK [fetch-tox-output : Set envlist fact] 2026-01-26 03:15:32.277195 | debian-bookworm | ok 2026-01-26 03:15:32.282853 | 2026-01-26 03:15:32.282950 | TASK [fetch-tox-output : Get tox version] 2026-01-26 03:15:33.149788 | debian-bookworm | ROOT: No loadable tox.ini or setup.cfg or pyproject.toml or tox.toml found, assuming empty tox.ini at /home/zuul 2026-01-26 03:15:33.167965 | debian-bookworm | 4.34.1 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2026-01-26 03:15:33.363120 | debian-bookworm | ok: Runtime: 0:00:00.302979 2026-01-26 03:15:33.367890 | 2026-01-26 03:15:33.367984 | TASK [fetch-tox-output : Find all default environments] 2026-01-26 03:15:33.909336 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:33.914533 | 2026-01-26 03:15:33.914634 | TASK [fetch-tox-output : Set envlist fact] 2026-01-26 03:15:33.958354 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:33.963067 | 2026-01-26 03:15:33.963151 | TASK [fetch-tox-output : Find all default environments] 2026-01-26 03:15:34.528434 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:34.537176 | 2026-01-26 03:15:34.537266 | TASK [fetch-tox-output : Set envlist fact] 2026-01-26 03:15:34.583565 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:34.590740 | 2026-01-26 03:15:34.590908 | LOOP [fetch-tox-output : Copy tox logs] 2026-01-26 03:15:34.674754 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:34.685650 | 2026-01-26 03:15:34.685797 | LOOP [fetch-tox-output : Collect tox logs] 2026-01-26 03:15:35.806683 | debian-bookworm | changed: 2026-01-26 03:15:35.807279 | debian-bookworm | created directory /var/lib/zuul/builds/72d9c0e63978488f85cff58070f944e6/work/logs/tox/test 2026-01-26 03:15:35.807320 | debian-bookworm | cd+++++++++ ./ 2026-01-26 03:15:35.807341 | debian-bookworm | >f+++++++++ 1-commands[0].log 2026-01-26 03:15:35.807365 | 2026-01-26 03:15:35.816654 | 2026-01-26 03:15:35.816821 | PLAY RECAP 2026-01-26 03:15:35.816890 | debian-bookworm | ok: 5 changed: 3 unreachable: 0 failed: 0 skipped: 7 rescued: 0 ignored: 0 2026-01-26 03:15:35.816915 | 2026-01-26 03:15:35.958473 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2026-01-26 03:15:35.959932 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2026-01-26 03:15:36.809435 | 2026-01-26 03:15:36.809582 | PLAY [all] 2026-01-26 03:15:36.837211 | 2026-01-26 03:15:36.837337 | TASK [fetch-subunit-output : Find stestr or testr executable] 2026-01-26 03:15:37.112032 | debian-bookworm | changed: non-zero return code 2026-01-26 03:15:37.120068 | 2026-01-26 03:15:37.120211 | TASK [fetch-subunit-output : Get the list of directories with subunit files] 2026-01-26 03:15:37.186995 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:37.194484 | 2026-01-26 03:15:37.194601 | LOOP [fetch-subunit-output : Find any inflight partial subunit files] 2026-01-26 03:15:37.262870 | 2026-01-26 03:15:37.263053 | LOOP [fetch-subunit-output : Copy any inflight subunit files] 2026-01-26 03:15:37.295818 | 2026-01-26 03:15:37.295996 | TASK [fetch-subunit-output : Create a temporary file to store the subunit stream] 2026-01-26 03:15:37.329280 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:37.335070 | 2026-01-26 03:15:37.335173 | LOOP [fetch-subunit-output : Generate subunit file] 2026-01-26 03:15:37.363832 | 2026-01-26 03:15:37.364008 | TASK [fetch-subunit-output : Copy the combined subunit file to the zuul work directory] 2026-01-26 03:15:37.376954 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:37.382366 | 2026-01-26 03:15:37.382467 | TASK [fetch-subunit-output : Remove the temporary file] 2026-01-26 03:15:37.397507 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:37.403315 | 2026-01-26 03:15:37.403415 | TASK [fetch-subunit-output : Process and fetch subunit results] 2026-01-26 03:15:37.416474 | debian-bookworm | skipping: Conditional result was False 2026-01-26 03:15:37.422634 | 2026-01-26 03:15:37.422702 | PLAY RECAP 2026-01-26 03:15:37.422748 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 8 rescued: 0 ignored: 0 2026-01-26 03:15:37.422797 | 2026-01-26 03:15:37.521025 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2026-01-26 03:15:37.521999 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-01-26 03:15:38.273331 | 2026-01-26 03:15:38.275068 | PLAY [Base post] 2026-01-26 03:15:38.299567 | 2026-01-26 03:15:38.299686 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-01-26 03:15:38.885210 | debian-bookworm | changed 2026-01-26 03:15:38.893631 | 2026-01-26 03:15:38.893729 | PLAY RECAP 2026-01-26 03:15:38.894104 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-01-26 03:15:38.894177 | 2026-01-26 03:15:39.175346 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-01-26 03:15:39.176350 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-01-26 03:15:40.275748 | 2026-01-26 03:15:40.275892 | PLAY [Base post-logs] 2026-01-26 03:15:40.284636 | 2026-01-26 03:15:40.284731 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-01-26 03:15:40.768565 | localhost | changed 2026-01-26 03:15:40.776274 | 2026-01-26 03:15:40.776374 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-01-26 03:15:40.813064 | localhost | ok 2026-01-26 03:15:40.815456 | 2026-01-26 03:15:40.815524 | TASK [Set zuul-log-path fact] 2026-01-26 03:15:40.839374 | localhost | ok 2026-01-26 03:15:40.845615 | 2026-01-26 03:15:40.845698 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-01-26 03:15:40.887598 | localhost | ok 2026-01-26 03:15:40.889941 | 2026-01-26 03:15:40.890021 | TASK [upload-logs : Create log directories] 2026-01-26 03:15:41.358406 | localhost | changed 2026-01-26 03:15:41.360598 | 2026-01-26 03:15:41.360671 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-01-26 03:15:41.932699 | localhost -> localhost | ok: Runtime: 0:00:00.012025 2026-01-26 03:15:41.935734 | 2026-01-26 03:15:41.935838 | TASK [upload-logs : Upload logs to log server] 2026-01-26 03:15:42.431856 | localhost | Output suppressed because no_log was given 2026-01-26 03:15:42.433262 | 2026-01-26 03:15:42.433337 | LOOP [upload-logs : Compress console log and json output] 2026-01-26 03:15:42.491635 | localhost | skipping: Conditional result was False 2026-01-26 03:15:42.497447 | localhost | skipping: Conditional result was False 2026-01-26 03:15:42.508357 | 2026-01-26 03:15:42.508437 | LOOP [upload-logs : Upload compressed console log and json output] 2026-01-26 03:15:42.543313 | localhost | skipping: Conditional result was False 2026-01-26 03:15:42.543549 | 2026-01-26 03:15:42.548767 | localhost | skipping: Conditional result was False 2026-01-26 03:15:42.552814 | 2026-01-26 03:15:42.552893 | LOOP [upload-logs : Upload console log and json output]