2026-04-22 18:01:40.112258 | Job console starting 2026-04-22 18:01:40.150038 | Updating git repos 2026-04-22 18:01:40.233009 | Cloning repos into workspace 2026-04-22 18:01:40.299538 | Restoring repo states 2026-04-22 18:01:40.309337 | Merging changes 2026-04-22 18:01:40.913973 | Checking out repos 2026-04-22 18:01:41.009729 | Preparing playbooks 2026-04-22 18:01:42.177740 | Running Ansible setup 2026-04-22 18:01:47.450196 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-04-22 18:01:48.408318 | 2026-04-22 18:01:48.408560 | PLAY [Base pre] 2026-04-22 18:01:48.482693 | 2026-04-22 18:01:48.482949 | TASK [Setup log path fact] 2026-04-22 18:01:48.525115 | debian-bookworm | ok 2026-04-22 18:01:48.558574 | 2026-04-22 18:01:48.558776 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-22 18:01:48.611715 | debian-bookworm | ok 2026-04-22 18:01:48.631918 | 2026-04-22 18:01:48.632075 | TASK [emit-job-header : Print job information] 2026-04-22 18:01:48.713375 | # Job Information 2026-04-22 18:01:48.713637 | Ansible Version: 2.16.14 2026-04-22 18:01:48.713674 | Job: tox 2026-04-22 18:01:48.713708 | Pipeline: check 2026-04-22 18:01:48.713731 | Executor: 521e9411259a 2026-04-22 18:01:48.713752 | Triggered by: https://github.com/osism/openstack-image-manager/pull/1214 2026-04-22 18:01:48.713774 | Event ID: 49a98c20-3e75-11f1-8cc2-699058c5b416 2026-04-22 18:01:48.719026 | 2026-04-22 18:01:48.719144 | LOOP [emit-job-header : Print node information] 2026-04-22 18:01:48.909687 | debian-bookworm | ok: 2026-04-22 18:01:48.909924 | debian-bookworm | # Node Information 2026-04-22 18:01:48.909957 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-04-22 18:01:48.909981 | debian-bookworm | Hostname: debian 2026-04-22 18:01:48.910003 | debian-bookworm | Username: zuul 2026-04-22 18:01:48.910024 | debian-bookworm | Distro: Debian 12.13 2026-04-22 18:01:48.910047 | debian-bookworm | Provider: regiocloud-a 2026-04-22 18:01:48.910069 | debian-bookworm | Region: 2026-04-22 18:01:48.910089 | debian-bookworm | Label: debian-bookworm 2026-04-22 18:01:48.910109 | debian-bookworm | Product Name: OpenStack Nova 2026-04-22 18:01:48.910129 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe21:326f 2026-04-22 18:01:48.936284 | 2026-04-22 18:01:48.936462 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-22 18:01:49.715799 | debian-bookworm -> localhost | changed 2026-04-22 18:01:49.723811 | 2026-04-22 18:01:49.723932 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-22 18:01:51.184166 | debian-bookworm -> localhost | changed 2026-04-22 18:01:51.192867 | 2026-04-22 18:01:51.192952 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-22 18:01:51.678499 | debian-bookworm -> localhost | ok 2026-04-22 18:01:51.683561 | 2026-04-22 18:01:51.683650 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-22 18:01:51.710289 | debian-bookworm | ok 2026-04-22 18:01:51.736496 | debian-bookworm | included: /var/lib/zuul/builds/9715a9fb4eca4bd68a41597f9574825f/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-22 18:01:51.741457 | 2026-04-22 18:01:51.741533 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-22 18:01:53.209045 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-04-22 18:01:53.209226 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/9715a9fb4eca4bd68a41597f9574825f/work/9715a9fb4eca4bd68a41597f9574825f_id_rsa 2026-04-22 18:01:53.209258 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/9715a9fb4eca4bd68a41597f9574825f/work/9715a9fb4eca4bd68a41597f9574825f_id_rsa.pub 2026-04-22 18:01:53.209280 | debian-bookworm -> localhost | The key fingerprint is: 2026-04-22 18:01:53.209300 | debian-bookworm -> localhost | SHA256:+S3vbMUJ3x/sGiw3xtgPGvIwimuZME170tJPZ2wyX80 zuul-build-sshkey 2026-04-22 18:01:53.209318 | debian-bookworm -> localhost | The key's randomart image is: 2026-04-22 18:01:53.209342 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-04-22 18:01:53.209360 | debian-bookworm -> localhost | | | 2026-04-22 18:01:53.209378 | debian-bookworm -> localhost | | | 2026-04-22 18:01:53.209421 | debian-bookworm -> localhost | | | 2026-04-22 18:01:53.209438 | debian-bookworm -> localhost | | . . . | 2026-04-22 18:01:53.209454 | debian-bookworm -> localhost | | o + S . ++o | 2026-04-22 18:01:53.209478 | debian-bookworm -> localhost | | o = + = *=.=E.| 2026-04-22 18:01:53.209497 | debian-bookworm -> localhost | | o * o+X+o@. o| 2026-04-22 18:01:53.209514 | debian-bookworm -> localhost | | +. ..==B =..| 2026-04-22 18:01:53.209531 | debian-bookworm -> localhost | | .o.. =+... | 2026-04-22 18:01:53.209547 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-04-22 18:01:53.209589 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.732572 2026-04-22 18:01:53.214643 | 2026-04-22 18:01:53.214716 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-22 18:01:53.239050 | debian-bookworm | ok 2026-04-22 18:01:53.261304 | debian-bookworm | included: /var/lib/zuul/builds/9715a9fb4eca4bd68a41597f9574825f/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-22 18:01:53.286326 | 2026-04-22 18:01:53.286458 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-22 18:01:53.309985 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:01:53.316911 | 2026-04-22 18:01:53.317032 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-22 18:01:53.941878 | debian-bookworm | changed 2026-04-22 18:01:53.947628 | 2026-04-22 18:01:53.947751 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-22 18:01:54.215011 | debian-bookworm | ok 2026-04-22 18:01:54.221819 | 2026-04-22 18:01:54.221918 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-22 18:01:54.840613 | debian-bookworm | changed 2026-04-22 18:01:54.848055 | 2026-04-22 18:01:54.848152 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-22 18:01:55.512452 | debian-bookworm | changed 2026-04-22 18:01:55.517881 | 2026-04-22 18:01:55.517966 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-22 18:01:55.541184 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:01:55.547175 | 2026-04-22 18:01:55.547842 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-22 18:01:55.985876 | debian-bookworm -> localhost | changed 2026-04-22 18:01:56.003732 | 2026-04-22 18:01:56.004549 | TASK [add-build-sshkey : Add back temp key] 2026-04-22 18:01:56.557197 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/9715a9fb4eca4bd68a41597f9574825f/work/9715a9fb4eca4bd68a41597f9574825f_id_rsa (zuul-build-sshkey) 2026-04-22 18:01:56.557420 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.026182 2026-04-22 18:01:56.565155 | 2026-04-22 18:01:56.565257 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-22 18:01:56.960793 | debian-bookworm | ok 2026-04-22 18:01:56.965767 | 2026-04-22 18:01:56.965854 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-22 18:01:56.994659 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:01:57.005549 | 2026-04-22 18:01:57.005654 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-04-22 18:01:57.446005 | debian-bookworm | ok 2026-04-22 18:01:57.458784 | 2026-04-22 18:01:57.458918 | TASK [validate-host : Define zuul_info_dir fact] 2026-04-22 18:01:57.487298 | debian-bookworm | ok 2026-04-22 18:01:57.492107 | 2026-04-22 18:01:57.492191 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-04-22 18:01:57.747984 | debian-bookworm -> localhost | ok 2026-04-22 18:01:57.759543 | 2026-04-22 18:01:57.759661 | TASK [validate-host : Collect information about the host] 2026-04-22 18:01:58.867900 | debian-bookworm | ok 2026-04-22 18:01:58.886691 | 2026-04-22 18:01:58.886797 | TASK [validate-host : Sanitize hostname] 2026-04-22 18:01:59.019837 | debian-bookworm | ok 2026-04-22 18:01:59.048934 | 2026-04-22 18:01:59.049035 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-04-22 18:01:59.614454 | debian-bookworm -> localhost | changed 2026-04-22 18:01:59.620261 | 2026-04-22 18:01:59.620356 | TASK [validate-host : Collect information about zuul worker] 2026-04-22 18:02:00.034298 | debian-bookworm | ok 2026-04-22 18:02:00.039176 | 2026-04-22 18:02:00.039286 | TASK [validate-host : Write out all zuul information for each host] 2026-04-22 18:02:00.742493 | debian-bookworm -> localhost | changed 2026-04-22 18:02:00.753267 | 2026-04-22 18:02:00.753435 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-04-22 18:02:01.016978 | debian-bookworm | ok 2026-04-22 18:02:01.024260 | 2026-04-22 18:02:01.024440 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-04-22 18:02:01.998154 | debian-bookworm | changed: 2026-04-22 18:02:01.998368 | debian-bookworm | cd+++++++++ src/ 2026-04-22 18:02:01.998423 | debian-bookworm | cd+++++++++ src/github.com/ 2026-04-22 18:02:01.998448 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-04-22 18:02:01.998470 | debian-bookworm | cd+++++++++ src/github.com/osism/openstack-image-manager/ 2026-04-22 18:02:01.998491 | debian-bookworm | =7.0.3 2026-04-22 18:02:25.732912 | debian-bookworm | Downloading cachetools-7.0.6-py3-none-any.whl (13 kB) 2026-04-22 18:02:25.775340 | debian-bookworm | Collecting colorama>=0.4.6 2026-04-22 18:02:25.787547 | debian-bookworm | Downloading colorama-0.4.6-py2.py3-none-any.whl (25 kB) 2026-04-22 18:02:25.847956 | debian-bookworm | Collecting filelock>=3.25 2026-04-22 18:02:25.860059 | debian-bookworm | Downloading filelock-3.29.0-py3-none-any.whl (39 kB) 2026-04-22 18:02:25.919318 | debian-bookworm | Collecting packaging>=26 2026-04-22 18:02:25.930627 | debian-bookworm | Downloading packaging-26.1-py3-none-any.whl (95 kB) 2026-04-22 18:02:25.941452 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 95.8/95.8 kB 11.0 MB/s eta 0:00:00 2026-04-22 18:02:25.991439 | debian-bookworm | Collecting platformdirs>=4.9.4 2026-04-22 18:02:26.003524 | debian-bookworm | Downloading platformdirs-4.9.6-py3-none-any.whl (21 kB) 2026-04-22 18:02:26.045531 | debian-bookworm | Collecting pluggy>=1.6 2026-04-22 18:02:26.057134 | debian-bookworm | Downloading pluggy-1.6.0-py3-none-any.whl (20 kB) 2026-04-22 18:02:26.098217 | debian-bookworm | Collecting pyproject-api>=1.10 2026-04-22 18:02:26.110628 | debian-bookworm | Downloading pyproject_api-1.10.0-py3-none-any.whl (13 kB) 2026-04-22 18:02:26.143466 | debian-bookworm | Collecting python-discovery>=1.2.2 2026-04-22 18:02:26.154842 | debian-bookworm | Downloading python_discovery-1.2.2-py3-none-any.whl (31 kB) 2026-04-22 18:02:26.189564 | debian-bookworm | Collecting tomli-w>=1.2 2026-04-22 18:02:26.201981 | debian-bookworm | Downloading tomli_w-1.2.0-py3-none-any.whl (6.7 kB) 2026-04-22 18:02:26.366563 | debian-bookworm | Collecting virtualenv>=21.1 2026-04-22 18:02:26.380224 | debian-bookworm | Downloading virtualenv-21.2.4-py3-none-any.whl (5.8 MB) 2026-04-22 18:02:26.647566 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 5.8/5.8 MB 22.1 MB/s eta 0:00:00 2026-04-22 18:02:26.765142 | debian-bookworm | Collecting distlib<1,>=0.3.7 2026-04-22 18:02:26.777812 | debian-bookworm | Downloading distlib-0.4.0-py2.py3-none-any.whl (469 kB) 2026-04-22 18:02:26.798286 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 469.0/469.0 kB 27.3 MB/s eta 0:00:00 2026-04-22 18:02:26.906003 | debian-bookworm | Installing collected packages: distlib, tomli-w, pluggy, platformdirs, packaging, filelock, colorama, cachetools, python-discovery, pyproject-api, virtualenv, tox 2026-04-22 18:02:27.633414 | debian-bookworm | Successfully installed cachetools-7.0.6 colorama-0.4.6 distlib-0.4.0 filelock-3.29.0 packaging-26.1 platformdirs-4.9.6 pluggy-1.6.0 pyproject-api-1.10.0 python-discovery-1.2.2 tomli-w-1.2.0 tox-4.53.0 virtualenv-21.2.4 2026-04-22 18:02:28.069914 | debian-bookworm | ok: Runtime: 0:00:02.928261 2026-04-22 18:02:28.076357 | 2026-04-22 18:02:28.076514 | TASK [ensure-tox : Export installed tox_executable path] 2026-04-22 18:02:28.145596 | debian-bookworm | ok 2026-04-22 18:02:28.166990 | 2026-04-22 18:02:28.167136 | TASK [ensure-tox : Output tox version] 2026-04-22 18:02:28.771405 | 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-04-22 18:02:28.790603 | debian-bookworm | 4.53.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2026-04-22 18:02:29.216213 | debian-bookworm | ok: Runtime: 0:00:00.327669 2026-04-22 18:02:29.222928 | 2026-04-22 18:02:29.223032 | TASK [ensure-tox : Make global symlink] 2026-04-22 18:02:29.275928 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:29.287090 | 2026-04-22 18:02:29.287198 | PLAY RECAP 2026-04-22 18:02:29.287257 | debian-bookworm | ok: 13 changed: 9 unreachable: 0 failed: 0 skipped: 14 rescued: 0 ignored: 0 2026-04-22 18:02:29.287281 | 2026-04-22 18:02:29.435076 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/pre.yaml@master] 2026-04-22 18:02:29.436312 | RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2026-04-22 18:02:30.245249 | 2026-04-22 18:02:30.245456 | PLAY [all] 2026-04-22 18:02:30.265131 | 2026-04-22 18:02:30.265287 | TASK [revoke-sudo : Check if zuul is sudoer] 2026-04-22 18:02:30.827635 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2026-04-22 18:02:31.312594 | debian-bookworm | ok: Runtime: 0:00:00.029856 2026-04-22 18:02:31.319301 | 2026-04-22 18:02:31.319473 | TASK [revoke-sudo : Remove sudo access for zuul user.] 2026-04-22 18:02:31.854821 | debian-bookworm | ok: Runtime: 0:00:00.006178 2026-04-22 18:02:31.868831 | 2026-04-22 18:02:31.869011 | TASK [revoke-sudo : Prove that general sudo access is actually revoked.] 2026-04-22 18:02:32.190686 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2026-04-22 18:02:32.192976 | debian-bookworm | sudo: a password is required 2026-04-22 18:02:32.405157 | debian-bookworm | ok: Runtime: 0:00:00.023880 2026-04-22 18:02:32.431473 | 2026-04-22 18:02:32.431658 | TASK [tox : Check to see if the constraints file exists] 2026-04-22 18:02:32.467711 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:32.477608 | 2026-04-22 18:02:32.477748 | TASK [tox : Fail if constraints file is missing] 2026-04-22 18:02:32.513147 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:32.526687 | 2026-04-22 18:02:32.526924 | TASK [tox : Record file location] 2026-04-22 18:02:32.553080 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:32.563136 | 2026-04-22 18:02:32.563296 | TASK [tox : Install tox siblings] 2026-04-22 18:02:32.587648 | debian-bookworm | ok 2026-04-22 18:02:32.596457 | debian-bookworm | included: /var/lib/zuul/builds/9715a9fb4eca4bd68a41597f9574825f/untrusted/project_0/github.com/osism/openinfra-zuul-jobs/roles/tox/tasks/siblings.yaml 2026-04-22 18:02:32.602167 | 2026-04-22 18:02:32.602278 | TASK [tox : Run tox without tests] 2026-04-22 18:02:33.890579 | debian-bookworm | test: install_deps> python -I -m pip install -r requirements.txt 2026-04-22 18:02:47.708066 | debian-bookworm | test: OK (14.56 seconds) 2026-04-22 18:02:47.708136 | debian-bookworm | congratulations :) (14.59 seconds) 2026-04-22 18:02:48.141538 | debian-bookworm | ok: Runtime: 0:00:14.874626 2026-04-22 18:02:48.153561 | 2026-04-22 18:02:48.153725 | TASK [tox : Create a tempfile to save tox showconfig] 2026-04-22 18:02:48.587155 | debian-bookworm | changed 2026-04-22 18:02:48.594816 | 2026-04-22 18:02:48.594958 | TASK [tox : Get tox envlist config] 2026-04-22 18:02:49.638760 | debian-bookworm | ok: Runtime: 0:00:00.352336 2026-04-22 18:02:49.651189 | 2026-04-22 18:02:49.651414 | TASK [tox : Install any sibling python packages] 2026-04-22 18:02:50.108997 | debian-bookworm | ok: No setup.cfg, no action needed 2026-04-22 18:02:50.115001 | 2026-04-22 18:02:50.115123 | TASK [tox : Remove tempfile] 2026-04-22 18:02:50.559497 | debian-bookworm | changed 2026-04-22 18:02:50.567855 | 2026-04-22 18:02:50.567987 | TASK [tox : Emit tox command] 2026-04-22 18:02:50.615590 | /home/zuul/.local/tox/bin/tox -etest -- test/unit 2026-04-22 18:02:50.626640 | 2026-04-22 18:02:50.627016 | TASK [tox : Run tox] 2026-04-22 18:02:51.337827 | debian-bookworm | test: commands[0]> python -m unittest discover test/unit 2026-04-22 18:02:52.151388 | debian-bookworm | ............... 2026-04-22 18:02:52.151436 | debian-bookworm | ---------------------------------------------------------------------- 2026-04-22 18:02:52.151452 | debian-bookworm | Ran 15 tests in 0.216s 2026-04-22 18:02:52.151457 | debian-bookworm | 2026-04-22 18:02:52.151464 | debian-bookworm | OK 2026-04-22 18:02:52.247542 | debian-bookworm | test: OK (0.96=setup[0.05]+cmd[0.91] seconds) 2026-04-22 18:02:52.247608 | debian-bookworm | congratulations :) (0.99 seconds) 2026-04-22 18:02:52.705898 | debian-bookworm | ok: Runtime: 0:00:01.302552 2026-04-22 18:02:52.716514 | 2026-04-22 18:02:52.716688 | TASK [tox : Look for output] 2026-04-22 18:02:53.131456 | debian-bookworm | ok 2026-04-22 18:02:53.150855 | 2026-04-22 18:02:53.151023 | TASK [tox : Return file comments to Zuul] 2026-04-22 18:02:53.187621 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:53.199301 | 2026-04-22 18:02:53.199433 | PLAY RECAP 2026-04-22 18:02:53.199514 | debian-bookworm | ok: 12 changed: 8 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 0 2026-04-22 18:02:53.199551 | 2026-04-22 18:02:53.362982 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2026-04-22 18:02:53.366532 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2026-04-22 18:02:54.135330 | 2026-04-22 18:02:54.135557 | PLAY [all] 2026-04-22 18:02:54.152125 | 2026-04-22 18:02:54.152299 | TASK [fetch-tox-output : Set tox log path for multiple nodes] 2026-04-22 18:02:54.229346 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:54.243727 | 2026-04-22 18:02:54.243990 | TASK [fetch-tox-output : Set tox log path for single node] 2026-04-22 18:02:54.292382 | debian-bookworm | ok 2026-04-22 18:02:54.301530 | 2026-04-22 18:02:54.301708 | TASK [fetch-tox-output : Ensure local tox dir] 2026-04-22 18:02:54.805142 | debian-bookworm -> localhost | changed 2026-04-22 18:02:54.816126 | 2026-04-22 18:02:54.816265 | TASK [fetch-tox-output : Ensure zuul-output tox dir] 2026-04-22 18:02:54.881502 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:54.895536 | 2026-04-22 18:02:54.895724 | TASK [fetch-tox-output : Set envlist fact] 2026-04-22 18:02:54.952650 | debian-bookworm | ok 2026-04-22 18:02:54.965009 | 2026-04-22 18:02:54.965257 | TASK [fetch-tox-output : Get tox version] 2026-04-22 18:02:55.668521 | 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-04-22 18:02:55.687759 | debian-bookworm | 4.53.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2026-04-22 18:02:56.001040 | debian-bookworm | ok: Runtime: 0:00:00.305530 2026-04-22 18:02:56.014766 | 2026-04-22 18:02:56.015012 | TASK [fetch-tox-output : Find all default environments] 2026-04-22 18:02:56.551301 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:56.559892 | 2026-04-22 18:02:56.560063 | TASK [fetch-tox-output : Set envlist fact] 2026-04-22 18:02:56.596508 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:56.610627 | 2026-04-22 18:02:56.610820 | TASK [fetch-tox-output : Find all default environments] 2026-04-22 18:02:57.144936 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:57.158992 | 2026-04-22 18:02:57.159173 | TASK [fetch-tox-output : Set envlist fact] 2026-04-22 18:02:57.195919 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:57.209981 | 2026-04-22 18:02:57.210145 | LOOP [fetch-tox-output : Copy tox logs] 2026-04-22 18:02:57.263830 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:57.283086 | 2026-04-22 18:02:57.283259 | LOOP [fetch-tox-output : Collect tox logs] 2026-04-22 18:02:58.086389 | debian-bookworm | changed: 2026-04-22 18:02:58.086656 | debian-bookworm | created directory /var/lib/zuul/builds/9715a9fb4eca4bd68a41597f9574825f/work/logs/tox/test 2026-04-22 18:02:58.086692 | debian-bookworm | cd+++++++++ ./ 2026-04-22 18:02:58.086718 | debian-bookworm | >f+++++++++ 1-commands[0].log 2026-04-22 18:02:58.086747 | 2026-04-22 18:02:58.096630 | 2026-04-22 18:02:58.096725 | PLAY RECAP 2026-04-22 18:02:58.096778 | debian-bookworm | ok: 5 changed: 3 unreachable: 0 failed: 0 skipped: 7 rescued: 0 ignored: 0 2026-04-22 18:02:58.096803 | 2026-04-22 18:02:58.227168 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2026-04-22 18:02:58.228276 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2026-04-22 18:02:58.959584 | 2026-04-22 18:02:58.959750 | PLAY [all] 2026-04-22 18:02:58.975627 | 2026-04-22 18:02:58.975766 | TASK [fetch-subunit-output : Find stestr or testr executable] 2026-04-22 18:02:59.218234 | debian-bookworm | changed: non-zero return code 2026-04-22 18:02:59.224289 | 2026-04-22 18:02:59.224461 | TASK [fetch-subunit-output : Get the list of directories with subunit files] 2026-04-22 18:02:59.249690 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:59.256290 | 2026-04-22 18:02:59.256459 | LOOP [fetch-subunit-output : Find any inflight partial subunit files] 2026-04-22 18:02:59.289890 | 2026-04-22 18:02:59.290115 | LOOP [fetch-subunit-output : Copy any inflight subunit files] 2026-04-22 18:02:59.326134 | 2026-04-22 18:02:59.326370 | TASK [fetch-subunit-output : Create a temporary file to store the subunit stream] 2026-04-22 18:02:59.351686 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:59.362734 | 2026-04-22 18:02:59.362906 | LOOP [fetch-subunit-output : Generate subunit file] 2026-04-22 18:02:59.401324 | 2026-04-22 18:02:59.401666 | TASK [fetch-subunit-output : Copy the combined subunit file to the zuul work directory] 2026-04-22 18:02:59.427570 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:59.438071 | 2026-04-22 18:02:59.438216 | TASK [fetch-subunit-output : Remove the temporary file] 2026-04-22 18:02:59.463359 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:59.469664 | 2026-04-22 18:02:59.469795 | TASK [fetch-subunit-output : Process and fetch subunit results] 2026-04-22 18:02:59.494678 | debian-bookworm | skipping: Conditional result was False 2026-04-22 18:02:59.508765 | 2026-04-22 18:02:59.508885 | PLAY RECAP 2026-04-22 18:02:59.508974 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 8 rescued: 0 ignored: 0 2026-04-22 18:02:59.509014 | 2026-04-22 18:02:59.638033 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2026-04-22 18:02:59.641216 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-04-22 18:03:00.380684 | 2026-04-22 18:03:00.380864 | PLAY [Base post] 2026-04-22 18:03:00.394675 | 2026-04-22 18:03:00.394816 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-22 18:03:00.966145 | debian-bookworm | changed 2026-04-22 18:03:00.972742 | 2026-04-22 18:03:00.972860 | PLAY RECAP 2026-04-22 18:03:00.972923 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-22 18:03:00.972986 | 2026-04-22 18:03:01.094471 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-04-22 18:03:01.097683 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-22 18:03:01.941704 | 2026-04-22 18:03:01.941876 | PLAY [Base post-logs] 2026-04-22 18:03:01.952645 | 2026-04-22 18:03:01.952789 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-22 18:03:02.446216 | localhost | changed 2026-04-22 18:03:02.456853 | 2026-04-22 18:03:02.457016 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-22 18:03:02.493380 | localhost | ok 2026-04-22 18:03:02.496829 | 2026-04-22 18:03:02.496937 | TASK [Set zuul-log-path fact] 2026-04-22 18:03:02.522432 | localhost | ok 2026-04-22 18:03:02.530890 | 2026-04-22 18:03:02.531003 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-22 18:03:02.568777 | localhost | ok 2026-04-22 18:03:02.575099 | 2026-04-22 18:03:02.575250 | TASK [upload-logs : Create log directories] 2026-04-22 18:03:03.111833 | localhost | changed 2026-04-22 18:03:03.114784 | 2026-04-22 18:03:03.114936 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-22 18:03:03.639868 | localhost -> localhost | ok: Runtime: 0:00:00.008185 2026-04-22 18:03:03.649138 | 2026-04-22 18:03:03.649356 | TASK [upload-logs : Upload logs to log server] 2026-04-22 18:03:04.227310 | localhost | Output suppressed because no_log was given 2026-04-22 18:03:04.230982 | 2026-04-22 18:03:04.231196 | LOOP [upload-logs : Compress console log and json output] 2026-04-22 18:03:04.295878 | localhost | skipping: Conditional result was False 2026-04-22 18:03:04.300836 | localhost | skipping: Conditional result was False 2026-04-22 18:03:04.310018 | 2026-04-22 18:03:04.310241 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-22 18:03:04.358224 | localhost | skipping: Conditional result was False 2026-04-22 18:03:04.359015 | 2026-04-22 18:03:04.362153 | localhost | skipping: Conditional result was False 2026-04-22 18:03:04.376618 | 2026-04-22 18:03:04.376887 | LOOP [upload-logs : Upload console log and json output]