2025-05-20 22:19:40.955886 | Job console starting 2025-05-20 22:19:40.974162 | Updating git repos 2025-05-20 22:19:41.011821 | Cloning repos into workspace 2025-05-20 22:19:41.058170 | Restoring repo states 2025-05-20 22:19:41.082471 | Merging changes 2025-05-20 22:19:41.589161 | Checking out repos 2025-05-20 22:19:41.622029 | Preparing playbooks 2025-05-20 22:19:42.567190 | Running Ansible setup 2025-05-20 22:19:48.236004 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-05-20 22:19:49.555645 | 2025-05-20 22:19:49.566043 | PLAY [Base pre] 2025-05-20 22:19:49.601014 | 2025-05-20 22:19:49.601185 | TASK [Setup log path fact] 2025-05-20 22:19:49.642514 | debian-bookworm | ok 2025-05-20 22:19:49.660039 | 2025-05-20 22:19:49.660206 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-05-20 22:19:49.710538 | debian-bookworm | ok 2025-05-20 22:19:49.720810 | 2025-05-20 22:19:49.720933 | TASK [emit-job-header : Print job information] 2025-05-20 22:19:49.760134 | # Job Information 2025-05-20 22:19:49.760328 | Ansible Version: 2.16.14 2025-05-20 22:19:49.760364 | Job: cfg-generics-tox-gilt 2025-05-20 22:19:49.760398 | Pipeline: check 2025-05-20 22:19:49.760422 | Executor: 521e9411259a 2025-05-20 22:19:49.760443 | Triggered by: https://github.com/osism/cfg-generics/pull/535 2025-05-20 22:19:49.760467 | Event ID: 81882540-35c8-11f0-92f3-20d306587013 2025-05-20 22:19:49.765378 | 2025-05-20 22:19:49.765495 | LOOP [emit-job-header : Print node information] 2025-05-20 22:19:49.882383 | debian-bookworm | ok: 2025-05-20 22:19:49.882582 | debian-bookworm | # Node Information 2025-05-20 22:19:49.882617 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-05-20 22:19:49.882731 | debian-bookworm | Hostname: debian 2025-05-20 22:19:49.882759 | debian-bookworm | Username: zuul 2025-05-20 22:19:49.882781 | debian-bookworm | Distro: Debian 12.11 2025-05-20 22:19:49.882806 | debian-bookworm | Provider: regiocloud-a 2025-05-20 22:19:49.882862 | debian-bookworm | Region: 2025-05-20 22:19:49.882888 | debian-bookworm | Label: debian-bookworm 2025-05-20 22:19:49.882909 | debian-bookworm | Product Name: OpenStack Nova 2025-05-20 22:19:49.882929 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe88:842b 2025-05-20 22:19:49.904299 | 2025-05-20 22:19:49.904454 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-05-20 22:19:50.609594 | debian-bookworm -> localhost | changed 2025-05-20 22:19:50.617108 | 2025-05-20 22:19:50.617244 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-05-20 22:19:52.908037 | debian-bookworm -> localhost | changed 2025-05-20 22:19:52.998624 | 2025-05-20 22:19:52.999318 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-05-20 22:19:53.679727 | debian-bookworm -> localhost | ok 2025-05-20 22:19:53.692384 | 2025-05-20 22:19:53.692861 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-05-20 22:19:53.747716 | debian-bookworm | ok 2025-05-20 22:19:53.797860 | debian-bookworm | included: /var/lib/zuul/builds/40d49be7ce7d462681a40fdf91c6191b/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-05-20 22:19:53.808189 | 2025-05-20 22:19:53.808316 | TASK [add-build-sshkey : Create Temp SSH key] 2025-05-20 22:19:57.205542 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-05-20 22:19:57.205802 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/40d49be7ce7d462681a40fdf91c6191b/work/40d49be7ce7d462681a40fdf91c6191b_id_rsa 2025-05-20 22:19:57.205851 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/40d49be7ce7d462681a40fdf91c6191b/work/40d49be7ce7d462681a40fdf91c6191b_id_rsa.pub 2025-05-20 22:19:57.205875 | debian-bookworm -> localhost | The key fingerprint is: 2025-05-20 22:19:57.205897 | debian-bookworm -> localhost | SHA256:kbGstFGqX0q0PKaVjaftJQHqKfNSXioXn744FIuFozA zuul-build-sshkey 2025-05-20 22:19:57.205941 | debian-bookworm -> localhost | The key's randomart image is: 2025-05-20 22:19:57.206004 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-05-20 22:19:57.206026 | debian-bookworm -> localhost | | o | 2025-05-20 22:19:57.206045 | debian-bookworm -> localhost | | + + | 2025-05-20 22:19:57.206063 | debian-bookworm -> localhost | | . * = | 2025-05-20 22:19:57.206079 | debian-bookworm -> localhost | |E o o* X . | 2025-05-20 22:19:57.206096 | debian-bookworm -> localhost | |.o +oo% S | 2025-05-20 22:19:57.206117 | debian-bookworm -> localhost | |. ..=B.B . | 2025-05-20 22:19:57.206135 | debian-bookworm -> localhost | | o++=+.o . | 2025-05-20 22:19:57.206152 | debian-bookworm -> localhost | | o+=.o. o | 2025-05-20 22:19:57.206170 | debian-bookworm -> localhost | | +ooo.. | 2025-05-20 22:19:57.206243 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-05-20 22:19:57.206297 | debian-bookworm -> localhost | ok: Runtime: 0:00:02.166685 2025-05-20 22:19:57.212922 | 2025-05-20 22:19:57.213062 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-05-20 22:19:57.242095 | debian-bookworm | ok 2025-05-20 22:19:57.253968 | debian-bookworm | included: /var/lib/zuul/builds/40d49be7ce7d462681a40fdf91c6191b/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-05-20 22:19:57.271202 | 2025-05-20 22:19:57.271291 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-05-20 22:19:57.299738 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:19:57.306347 | 2025-05-20 22:19:57.306428 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-05-20 22:19:58.149070 | debian-bookworm | changed 2025-05-20 22:19:58.154268 | 2025-05-20 22:19:58.154362 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-05-20 22:19:58.407629 | debian-bookworm | ok 2025-05-20 22:19:58.415061 | 2025-05-20 22:19:58.415157 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-05-20 22:19:59.053735 | debian-bookworm | changed 2025-05-20 22:19:59.063845 | 2025-05-20 22:19:59.063987 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-05-20 22:19:59.735348 | debian-bookworm | changed 2025-05-20 22:19:59.750804 | 2025-05-20 22:19:59.750949 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-05-20 22:19:59.794390 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:19:59.800171 | 2025-05-20 22:19:59.800266 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-05-20 22:20:00.280495 | debian-bookworm -> localhost | changed 2025-05-20 22:20:00.294353 | 2025-05-20 22:20:00.294482 | TASK [add-build-sshkey : Add back temp key] 2025-05-20 22:20:00.863623 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/40d49be7ce7d462681a40fdf91c6191b/work/40d49be7ce7d462681a40fdf91c6191b_id_rsa (zuul-build-sshkey) 2025-05-20 22:20:00.863859 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.014817 2025-05-20 22:20:00.873365 | 2025-05-20 22:20:00.873467 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-05-20 22:20:01.512516 | debian-bookworm | ok 2025-05-20 22:20:01.554421 | 2025-05-20 22:20:01.555872 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-05-20 22:20:01.618690 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:20:01.692477 | 2025-05-20 22:20:01.692630 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-05-20 22:20:02.485169 | debian-bookworm | ok 2025-05-20 22:20:02.504962 | 2025-05-20 22:20:02.505104 | TASK [validate-host : Define zuul_info_dir fact] 2025-05-20 22:20:02.573935 | debian-bookworm | ok 2025-05-20 22:20:02.579417 | 2025-05-20 22:20:02.579536 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-05-20 22:20:03.065547 | debian-bookworm -> localhost | ok 2025-05-20 22:20:03.078816 | 2025-05-20 22:20:03.078975 | TASK [validate-host : Collect information about the host] 2025-05-20 22:20:04.616253 | debian-bookworm | ok 2025-05-20 22:20:04.632354 | 2025-05-20 22:20:04.632587 | TASK [validate-host : Sanitize hostname] 2025-05-20 22:20:04.775411 | debian-bookworm | ok 2025-05-20 22:20:04.824702 | 2025-05-20 22:20:04.824846 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-05-20 22:20:05.778564 | debian-bookworm -> localhost | changed 2025-05-20 22:20:05.785370 | 2025-05-20 22:20:05.785505 | TASK [validate-host : Collect information about zuul worker] 2025-05-20 22:20:06.403991 | debian-bookworm | ok 2025-05-20 22:20:06.412421 | 2025-05-20 22:20:06.413090 | TASK [validate-host : Write out all zuul information for each host] 2025-05-20 22:20:07.798462 | debian-bookworm -> localhost | changed 2025-05-20 22:20:07.900191 | 2025-05-20 22:20:07.902702 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-05-20 22:20:08.253507 | debian-bookworm | ok 2025-05-20 22:20:08.261466 | 2025-05-20 22:20:08.261596 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-05-20 22:20:09.453977 | debian-bookworm | changed: 2025-05-20 22:20:09.454169 | debian-bookworm | cd+++++++++ src/ 2025-05-20 22:20:09.454205 | debian-bookworm | cd+++++++++ src/github.com/ 2025-05-20 22:20:09.454230 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-05-20 22:20:09.454253 | debian-bookworm | cd+++++++++ src/github.com/osism/cfg-generics/ 2025-05-20 22:20:09.454274 | debian-bookworm | =5.5.1 2025-05-20 22:20:32.368126 | debian-bookworm | Downloading cachetools-5.5.2-py3-none-any.whl (10 kB) 2025-05-20 22:20:32.395229 | debian-bookworm | Collecting chardet>=5.2 2025-05-20 22:20:32.402440 | debian-bookworm | Downloading chardet-5.2.0-py3-none-any.whl (199 kB) 2025-05-20 22:20:32.424734 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 199.4/199.4 kB 11.7 MB/s eta 0:00:00 2025-05-20 22:20:32.474016 | debian-bookworm | Collecting colorama>=0.4.6 2025-05-20 22:20:32.482002 | debian-bookworm | Downloading colorama-0.4.6-py2.py3-none-any.whl (25 kB) 2025-05-20 22:20:32.529320 | debian-bookworm | Collecting filelock>=3.16.1 2025-05-20 22:20:32.536930 | debian-bookworm | Downloading filelock-3.18.0-py3-none-any.whl (16 kB) 2025-05-20 22:20:32.579641 | debian-bookworm | Collecting packaging>=24.2 2025-05-20 22:20:32.586861 | debian-bookworm | Downloading packaging-25.0-py3-none-any.whl (66 kB) 2025-05-20 22:20:32.594952 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 66.5/66.5 kB 9.8 MB/s eta 0:00:00 2025-05-20 22:20:32.648118 | debian-bookworm | Collecting platformdirs>=4.3.6 2025-05-20 22:20:32.655433 | debian-bookworm | Downloading platformdirs-4.3.8-py3-none-any.whl (18 kB) 2025-05-20 22:20:32.689951 | debian-bookworm | Collecting pluggy>=1.5 2025-05-20 22:20:32.697086 | debian-bookworm | Downloading pluggy-1.6.0-py3-none-any.whl (20 kB) 2025-05-20 22:20:32.731452 | debian-bookworm | Collecting pyproject-api>=1.8 2025-05-20 22:20:32.738675 | debian-bookworm | Downloading pyproject_api-1.9.1-py3-none-any.whl (13 kB) 2025-05-20 22:20:32.868696 | debian-bookworm | Collecting virtualenv>=20.31 2025-05-20 22:20:32.876526 | debian-bookworm | Downloading virtualenv-20.31.2-py3-none-any.whl (6.1 MB) 2025-05-20 22:20:33.144763 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 6.1/6.1 MB 22.9 MB/s eta 0:00:00 2025-05-20 22:20:33.252083 | debian-bookworm | Collecting distlib<1,>=0.3.7 2025-05-20 22:20:33.259337 | debian-bookworm | Downloading distlib-0.3.9-py2.py3-none-any.whl (468 kB) 2025-05-20 22:20:33.289624 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 469.0/469.0 kB 18.9 MB/s eta 0:00:00 2025-05-20 22:20:33.442293 | debian-bookworm | Installing collected packages: distlib, pluggy, platformdirs, packaging, filelock, colorama, chardet, cachetools, virtualenv, pyproject-api, tox 2025-05-20 22:20:34.172908 | debian-bookworm | Successfully installed cachetools-5.5.2 chardet-5.2.0 colorama-0.4.6 distlib-0.3.9 filelock-3.18.0 packaging-25.0 platformdirs-4.3.8 pluggy-1.6.0 pyproject-api-1.9.1 tox-4.26.0 virtualenv-20.31.2 2025-05-20 22:20:34.403065 | debian-bookworm | ok: Runtime: 0:00:02.615970 2025-05-20 22:20:34.409280 | 2025-05-20 22:20:34.409402 | TASK [ensure-tox : Export installed tox_executable path] 2025-05-20 22:20:34.470896 | debian-bookworm | ok 2025-05-20 22:20:34.476643 | 2025-05-20 22:20:34.476793 | TASK [ensure-tox : Output tox version] 2025-05-20 22:20:35.073985 | debian-bookworm | ROOT: No tox.ini or setup.cfg or pyproject.toml or tox.toml found, assuming empty tox.ini at /home/zuul 2025-05-20 22:20:35.092422 | debian-bookworm | 4.26.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2025-05-20 22:20:35.535371 | debian-bookworm | ok: Runtime: 0:00:00.301838 2025-05-20 22:20:35.541284 | 2025-05-20 22:20:35.541400 | TASK [ensure-tox : Make global symlink] 2025-05-20 22:20:35.576024 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:20:35.583556 | 2025-05-20 22:20:35.583694 | PLAY RECAP 2025-05-20 22:20:35.583757 | debian-bookworm | ok: 13 changed: 9 unreachable: 0 failed: 0 skipped: 14 rescued: 0 ignored: 0 2025-05-20 22:20:35.583782 | 2025-05-20 22:20:35.739247 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/pre.yaml@master] 2025-05-20 22:20:35.740409 | RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2025-05-20 22:20:36.525250 | 2025-05-20 22:20:36.525424 | PLAY [all] 2025-05-20 22:20:36.541597 | 2025-05-20 22:20:36.541798 | TASK [revoke-sudo : Check if zuul is sudoer] 2025-05-20 22:20:37.051595 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2025-05-20 22:20:37.107290 | debian-bookworm | ok: Runtime: 0:00:00.029624 2025-05-20 22:20:37.115856 | 2025-05-20 22:20:37.116057 | TASK [revoke-sudo : Remove sudo access for zuul user.] 2025-05-20 22:20:37.645901 | debian-bookworm | ok: Runtime: 0:00:00.007390 2025-05-20 22:20:37.653072 | 2025-05-20 22:20:37.653212 | TASK [revoke-sudo : Prove that general sudo access is actually revoked.] 2025-05-20 22:20:38.040127 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2025-05-20 22:20:38.042589 | debian-bookworm | sudo: a password is required 2025-05-20 22:20:38.186469 | debian-bookworm | ok: Runtime: 0:00:00.025619 2025-05-20 22:20:38.203604 | 2025-05-20 22:20:38.203845 | TASK [tox : Check to see if the constraints file exists] 2025-05-20 22:20:38.240500 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:20:38.259211 | 2025-05-20 22:20:38.259446 | TASK [tox : Fail if constraints file is missing] 2025-05-20 22:20:38.297392 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:20:38.304488 | 2025-05-20 22:20:38.304697 | TASK [tox : Record file location] 2025-05-20 22:20:38.330014 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:20:38.346577 | 2025-05-20 22:20:38.347055 | TASK [tox : Install tox siblings] 2025-05-20 22:20:38.382415 | debian-bookworm | ok 2025-05-20 22:20:38.391478 | debian-bookworm | included: /var/lib/zuul/builds/40d49be7ce7d462681a40fdf91c6191b/untrusted/project_0/github.com/osism/openinfra-zuul-jobs/roles/tox/tasks/siblings.yaml 2025-05-20 22:20:38.397393 | 2025-05-20 22:20:38.397515 | TASK [tox : Run tox without tests] 2025-05-20 22:20:38.913557 | debian-bookworm | ROOT: 149 D setup logging to DEBUG on pid 1423 [tox/report.py:222] 2025-05-20 22:20:38.988034 | debian-bookworm | gilt: 223 D created app data folder /home/zuul/.local/share/virtualenv [virtualenv/app_data/__init__.py:42] 2025-05-20 22:20:38.990931 | debian-bookworm | gilt: 226 I find interpreter for spec PythonSpec(path=/home/zuul/.local/tox/bin/python3) [virtualenv/discovery/builtin.py:76] 2025-05-20 22:20:38.991404 | debian-bookworm | gilt: 227 D filesystem is case-sensitive [virtualenv/info.py:27] 2025-05-20 22:20:38.992431 | debian-bookworm | gilt: 228 D get interpreter info via cmd: /usr/bin/python3.11 /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/discovery/py_info.py wsai36m8ZtYFOqHQYyhOhGS4M0LQjHMb 5R5lsa3K8mV3TH2r0nIWG8vKQKd9R7Kg [virtualenv/discovery/cached_py_info.py:117] 2025-05-20 22:20:39.064152 | debian-bookworm | gilt: 299 D wrote python info of /usr/bin/python3.11 at /home/zuul/.local/share/virtualenv/py_info/2/ca3ed784184f1b3bb7c3539bfb45e71710cd27667424f92c2d5bb4df9c107c23.json [virtualenv/app_data/via_disk_folder.py:152] 2025-05-20 22:20:39.064653 | debian-bookworm | gilt: 300 I proposed PythonInfo(spec=CPython3.11.2.final.0-64, system=/usr/bin/python3.11, exe=/home/zuul/.local/tox/bin/python3, platform=linux, version='3.11.2 (main, Apr 28 2025, 14:11:48) [GCC 12.2.0]', encoding_fs_io=utf-8-utf-8) [virtualenv/discovery/builtin.py:83] 2025-05-20 22:20:39.065042 | debian-bookworm | gilt: 300 D accepted PythonInfo(spec=CPython3.11.2.final.0-64, system=/usr/bin/python3.11, exe=/home/zuul/.local/tox/bin/python3, platform=linux, version='3.11.2 (main, Apr 28 2025, 14:11:48) [GCC 12.2.0]', encoding_fs_io=utf-8-utf-8) [virtualenv/discovery/builtin.py:85] 2025-05-20 22:20:39.107348 | debian-bookworm | gilt: 342 I create virtual environment via CPython3Posix(dest=/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt, clear=False, no_vcs_ignore=False, global=False) [virtualenv/run/session.py:52] 2025-05-20 22:20:39.107782 | debian-bookworm | gilt: 343 D create folder /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/bin [virtualenv/util/path/_sync.py:14] 2025-05-20 22:20:39.108071 | debian-bookworm | gilt: 343 D create folder /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages [virtualenv/util/path/_sync.py:14] 2025-05-20 22:20:39.108387 | debian-bookworm | gilt: 344 D write /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/pyvenv.cfg [virtualenv/create/pyenv_cfg.py:35] 2025-05-20 22:20:39.108474 | debian-bookworm | gilt: 344 D home = /usr/bin [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.108548 | debian-bookworm | gilt: 344 D implementation = CPython [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.108600 | debian-bookworm | gilt: 344 D version_info = 3.11.2.final.0 [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.108658 | debian-bookworm | gilt: 344 D virtualenv = 20.31.2 [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.108713 | debian-bookworm | gilt: 344 D include-system-site-packages = false [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.108805 | debian-bookworm | gilt: 344 D base-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.108925 | debian-bookworm | gilt: 344 D base-exec-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.108985 | debian-bookworm | gilt: 344 D base-executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.109318 | debian-bookworm | gilt: 345 D symlink /usr/bin/python3.11 to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/bin/python [virtualenv/util/path/_sync.py:34] 2025-05-20 22:20:39.109698 | debian-bookworm | gilt: 345 D create virtualenv import hook file /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/_virtualenv.pth [virtualenv/create/via_global_ref/api.py:93] 2025-05-20 22:20:39.109925 | debian-bookworm | gilt: 345 D create /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/_virtualenv.py [virtualenv/create/via_global_ref/api.py:96] 2025-05-20 22:20:39.110416 | debian-bookworm | gilt: 346 D ============================== target debug ============================== [virtualenv/run/session.py:54] 2025-05-20 22:20:39.110687 | debian-bookworm | gilt: 346 D debug via /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/bin/python /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/create/debug.py [virtualenv/create/creator.py:215] 2025-05-20 22:20:39.153430 | debian-bookworm | gilt: 346 D { 2025-05-20 22:20:39.154813 | debian-bookworm | "sys": { 2025-05-20 22:20:39.154837 | debian-bookworm | "executable": "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/bin/python", 2025-05-20 22:20:39.154843 | debian-bookworm | "_base_executable": "/usr/bin/python3.11", 2025-05-20 22:20:39.154849 | debian-bookworm | "prefix": "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt", 2025-05-20 22:20:39.154855 | debian-bookworm | "base_prefix": "/usr", 2025-05-20 22:20:39.154861 | debian-bookworm | "real_prefix": null, 2025-05-20 22:20:39.154866 | debian-bookworm | "exec_prefix": "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt", 2025-05-20 22:20:39.154872 | debian-bookworm | "base_exec_prefix": "/usr", 2025-05-20 22:20:39.154876 | debian-bookworm | "path": [ 2025-05-20 22:20:39.154882 | debian-bookworm | "/usr/lib/python311.zip", 2025-05-20 22:20:39.154886 | debian-bookworm | "/usr/lib/python3.11", 2025-05-20 22:20:39.154890 | debian-bookworm | "/usr/lib/python3.11/lib-dynload", 2025-05-20 22:20:39.154895 | debian-bookworm | "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages" 2025-05-20 22:20:39.154899 | debian-bookworm | ], 2025-05-20 22:20:39.154903 | debian-bookworm | "meta_path": [ 2025-05-20 22:20:39.154907 | debian-bookworm | "", 2025-05-20 22:20:39.154912 | debian-bookworm | "", 2025-05-20 22:20:39.154916 | debian-bookworm | "", 2025-05-20 22:20:39.154920 | debian-bookworm | "" 2025-05-20 22:20:39.154924 | debian-bookworm | ], 2025-05-20 22:20:39.154929 | debian-bookworm | "fs_encoding": "utf-8", 2025-05-20 22:20:39.154933 | debian-bookworm | "io_encoding": "utf-8" 2025-05-20 22:20:39.154937 | debian-bookworm | }, 2025-05-20 22:20:39.154941 | debian-bookworm | "version": "3.11.2 (main, Apr 28 2025, 14:11:48) [GCC 12.2.0]", 2025-05-20 22:20:39.154945 | debian-bookworm | "makefile_filename": "/usr/lib/python3.11/config-3.11-x86_64-linux-gnu/Makefile", 2025-05-20 22:20:39.154949 | debian-bookworm | "os": "", 2025-05-20 22:20:39.154953 | debian-bookworm | "site": "", 2025-05-20 22:20:39.154957 | debian-bookworm | "datetime": "", 2025-05-20 22:20:39.154961 | debian-bookworm | "math": "", 2025-05-20 22:20:39.154965 | debian-bookworm | "json": "" 2025-05-20 22:20:39.154969 | debian-bookworm | } [virtualenv/run/session.py:55] 2025-05-20 22:20:39.154988 | debian-bookworm | gilt: 389 I add seed packages via FromAppData(download=False, pip=bundle, setuptools=bundle, via=copy, app_data_dir=/home/zuul/.local/share/virtualenv) [virtualenv/run/session.py:59] 2025-05-20 22:20:39.156527 | debian-bookworm | gilt: 392 D install pip from wheel /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/seed/wheels/embed/pip-25.1.1-py3-none-any.whl via CopyPipInstall [virtualenv/seed/embed/via_app_data/via_app_data.py:51] 2025-05-20 22:20:39.158511 | debian-bookworm | gilt: 393 D build install image for pip-25.1.1-py3-none-any.whl to /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-25.1.1-py3-none-any [virtualenv/seed/embed/via_app_data/pip_install/base.py:49] 2025-05-20 22:20:39.162227 | debian-bookworm | gilt: 397 D install setuptools from wheel /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/seed/wheels/embed/setuptools-80.3.1-py3-none-any.whl via CopyPipInstall [virtualenv/seed/embed/via_app_data/via_app_data.py:51] 2025-05-20 22:20:39.164978 | debian-bookworm | gilt: 400 D build install image for setuptools-80.3.1-py3-none-any.whl to /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-80.3.1-py3-none-any [virtualenv/seed/embed/via_app_data/pip_install/base.py:49] 2025-05-20 22:20:39.405331 | debian-bookworm | gilt: 641 D copy directory /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-80.3.1-py3-none-any/setuptools-80.3.1.dist-info to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/setuptools-80.3.1.dist-info [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.408585 | debian-bookworm | gilt: 644 D copy directory /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-80.3.1-py3-none-any/setuptools to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/setuptools [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.425535 | debian-bookworm | gilt: 661 D copy directory /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-25.1.1-py3-none-any/pip to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/pip [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.597270 | debian-bookworm | gilt: 833 D copy directory /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-25.1.1-py3-none-any/pip-25.1.1.dist-info to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/pip-25.1.1.dist-info [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.601311 | debian-bookworm | gilt: 837 D copy /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-25.1.1-py3-none-any/pip-25.1.1.virtualenv to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/pip-25.1.1.virtualenv [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.604655 | debian-bookworm | gilt: 840 D generated console scripts pip3.11 pip-3.11 pip pip3 [virtualenv/seed/embed/via_app_data/pip_install/base.py:45] 2025-05-20 22:20:39.613078 | debian-bookworm | gilt: 848 D copy /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-80.3.1-py3-none-any/setuptools-80.3.1.virtualenv to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/setuptools-80.3.1.virtualenv [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.613383 | debian-bookworm | gilt: 849 D copy directory /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-80.3.1-py3-none-any/_distutils_hack to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/_distutils_hack [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.613949 | debian-bookworm | gilt: 849 D copy directory /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-80.3.1-py3-none-any/pkg_resources to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/pkg_resources [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.617106 | debian-bookworm | gilt: 852 D copy /home/zuul/.local/share/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-80.3.1-py3-none-any/distutils-precedence.pth to /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages/distutils-precedence.pth [virtualenv/util/path/_sync.py:42] 2025-05-20 22:20:39.617362 | debian-bookworm | gilt: 853 D generated console scripts [virtualenv/seed/embed/via_app_data/pip_install/base.py:45] 2025-05-20 22:20:39.618197 | debian-bookworm | gilt: 853 I add activators for Bash, CShell, Fish, Nushell, PowerShell, Python [virtualenv/run/session.py:65] 2025-05-20 22:20:39.623839 | debian-bookworm | gilt: 859 D write /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/pyvenv.cfg [virtualenv/create/pyenv_cfg.py:35] 2025-05-20 22:20:39.623975 | debian-bookworm | gilt: 859 D home = /usr/bin [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.624050 | debian-bookworm | gilt: 860 D implementation = CPython [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.624113 | debian-bookworm | gilt: 860 D version_info = 3.11.2.final.0 [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.624174 | debian-bookworm | gilt: 860 D virtualenv = 20.31.2 [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.624231 | debian-bookworm | gilt: 860 D include-system-site-packages = false [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.624315 | debian-bookworm | gilt: 860 D base-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.624383 | debian-bookworm | gilt: 860 D base-exec-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.624463 | debian-bookworm | gilt: 860 D base-executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:40] 2025-05-20 22:20:39.626861 | debian-bookworm | gilt: OK (0.64 seconds) 2025-05-20 22:20:39.626917 | debian-bookworm | congratulations :) (0.72 seconds) 2025-05-20 22:20:39.936059 | debian-bookworm | ok: Runtime: 0:00:00.959671 2025-05-20 22:20:39.949549 | 2025-05-20 22:20:39.949723 | TASK [tox : Create a tempfile to save tox showconfig] 2025-05-20 22:20:40.372485 | debian-bookworm | changed 2025-05-20 22:20:40.381960 | 2025-05-20 22:20:40.382125 | TASK [tox : Get tox envlist config] 2025-05-20 22:20:41.417185 | debian-bookworm | ok: Runtime: 0:00:00.340904 2025-05-20 22:20:41.432509 | 2025-05-20 22:20:41.432712 | TASK [tox : Install any sibling python packages] 2025-05-20 22:20:41.896543 | debian-bookworm | ok: No setup.cfg, no action needed 2025-05-20 22:20:41.905080 | 2025-05-20 22:20:41.905229 | TASK [tox : Remove tempfile] 2025-05-20 22:20:42.354801 | debian-bookworm | changed 2025-05-20 22:20:42.362364 | 2025-05-20 22:20:42.362500 | TASK [tox : Emit tox command] 2025-05-20 22:20:42.407418 | /home/zuul/.local/tox/bin/tox -egilt -vv --skip-missing-interpreters=false 2025-05-20 22:20:42.415065 | 2025-05-20 22:20:42.415210 | TASK [tox : Run tox] 2025-05-20 22:20:42.929109 | debian-bookworm | ROOT: 141 D setup logging to DEBUG on pid 1456 [tox/report.py:222] 2025-05-20 22:20:43.004300 | debian-bookworm | gilt: 216 I find interpreter for spec PythonSpec(path=/home/zuul/.local/tox/bin/python3) [virtualenv/discovery/builtin.py:76] 2025-05-20 22:20:43.004786 | debian-bookworm | gilt: 217 D filesystem is case-sensitive [virtualenv/info.py:27] 2025-05-20 22:20:43.005682 | debian-bookworm | gilt: 218 D got python info of /usr/bin/python3.11 from /home/zuul/.local/share/virtualenv/py_info/2/ca3ed784184f1b3bb7c3539bfb45e71710cd27667424f92c2d5bb4df9c107c23.json [virtualenv/app_data/via_disk_folder.py:132] 2025-05-20 22:20:43.006332 | debian-bookworm | gilt: 219 I proposed PythonInfo(spec=CPython3.11.2.final.0-64, system=/usr/bin/python3.11, exe=/home/zuul/.local/tox/bin/python3, platform=linux, version='3.11.2 (main, Apr 28 2025, 14:11:48) [GCC 12.2.0]', encoding_fs_io=utf-8-utf-8) [virtualenv/discovery/builtin.py:83] 2025-05-20 22:20:43.006367 | debian-bookworm | gilt: 219 D accepted PythonInfo(spec=CPython3.11.2.final.0-64, system=/usr/bin/python3.11, exe=/home/zuul/.local/tox/bin/python3, platform=linux, version='3.11.2 (main, Apr 28 2025, 14:11:48) [GCC 12.2.0]', encoding_fs_io=utf-8-utf-8) [virtualenv/discovery/builtin.py:85] 2025-05-20 22:20:43.037075 | debian-bookworm | gilt: 249 W commands[0]> make sync [tox/tox_env/api.py:435] 2025-05-20 22:20:43.048229 | debian-bookworm | INFO: the file VAULTPASS_FILE='/secrets/vaultpass' does not exist and no running 'osism-ansible' container 2025-05-20 22:20:43.051265 | debian-bookworm | basename: missing operand 2025-05-20 22:20:43.051319 | debian-bookworm | Try 'basename --help' for more information. 2025-05-20 22:20:48.113402 | debian-bookworm | Collecting uv 2025-05-20 22:20:48.175280 | debian-bookworm | Downloading uv-0.7.6-py3-none-manylinux_2_17_x86_64.manylinux2014_x86_64.whl (17.4 MB) 2025-05-20 22:20:48.963990 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 17.4/17.4 MB 21.0 MB/s eta 0:00:00 2025-05-20 22:20:49.048310 | debian-bookworm | Installing collected packages: uv 2025-05-20 22:20:49.386968 | debian-bookworm | Successfully installed uv-0.7.6 2025-05-20 22:20:49.586868 | debian-bookworm | Using Python 3.11.2 environment at: venv 2025-05-20 22:20:50.620743 | debian-bookworm | Resolved 22 packages in 1.03s 2025-05-20 22:20:50.623526 | debian-bookworm | Building pwgen==0.8.2.post0 2025-05-20 22:20:50.666517 | debian-bookworm | Downloading cryptography (4.3MiB) 2025-05-20 22:20:50.666558 | debian-bookworm | Downloading ansible (52.9MiB) 2025-05-20 22:20:50.666564 | debian-bookworm | Downloading ansible-core (2.1MiB) 2025-05-20 22:20:51.048997 | debian-bookworm | Downloading ansible-core 2025-05-20 22:20:51.057678 | debian-bookworm | Downloading cryptography 2025-05-20 22:20:51.725882 | debian-bookworm | Built pwgen==0.8.2.post0 2025-05-20 22:20:54.591556 | debian-bookworm | Downloading ansible 2025-05-20 22:20:54.592046 | debian-bookworm | Prepared 22 packages in 3.97s 2025-05-20 22:20:55.113598 | debian-bookworm | Installed 22 packages in 505ms 2025-05-20 22:20:55.113682 | debian-bookworm | + ansible==11.6.0 2025-05-20 22:20:55.113688 | debian-bookworm | + ansible-core==2.18.6 2025-05-20 22:20:55.113693 | debian-bookworm | + certifi==2025.4.26 2025-05-20 22:20:55.113698 | debian-bookworm | + cffi==1.17.1 2025-05-20 22:20:55.113703 | debian-bookworm | + charset-normalizer==3.4.2 2025-05-20 22:20:55.113707 | debian-bookworm | + click==8.2.0 2025-05-20 22:20:55.113713 | debian-bookworm | + colorama==0.4.6 2025-05-20 22:20:55.113718 | debian-bookworm | + cryptography==45.0.2 2025-05-20 22:20:55.113721 | debian-bookworm | + fasteners==0.19 2025-05-20 22:20:55.113725 | debian-bookworm | + idna==3.10 2025-05-20 22:20:55.113730 | debian-bookworm | + jinja2==3.1.6 2025-05-20 22:20:55.113734 | debian-bookworm | + markupsafe==3.0.2 2025-05-20 22:20:55.113738 | debian-bookworm | + packaging==25.0 2025-05-20 22:20:55.113742 | debian-bookworm | + pwgen==0.8.2.post0 2025-05-20 22:20:55.113745 | debian-bookworm | + pycparser==2.22 2025-05-20 22:20:55.113749 | debian-bookworm | + python-gilt==1.2.3 2025-05-20 22:20:55.113753 | debian-bookworm | + pyyaml==6.0.2 2025-05-20 22:20:55.113757 | debian-bookworm | + requests==2.32.3 2025-05-20 22:20:55.113760 | debian-bookworm | + resolvelib==1.0.1 2025-05-20 22:20:55.113765 | debian-bookworm | + sh==2.2.2 2025-05-20 22:20:55.113769 | debian-bookworm | + tabulate==0.9.0 2025-05-20 22:20:55.113772 | debian-bookworm | + urllib3==2.4.0 2025-05-20 22:20:55.113776 | debian-bookworm | touch venv/bin/activate 2025-05-20 22:20:55.553209 | debian-bookworm | osism.cfg-generics: 2025-05-20 22:20:55.554409 | debian-bookworm | - cloning osism.cfg-generics to /home/zuul/.gilt/clone/github.com/osism.cfg-generics 2025-05-20 22:20:57.259075 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/gilt.yml to /home/zuul/src/github.com/osism/cfg-generics/./gilt.yml 2025-05-20 22:20:57.260029 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/requirements.txt to /home/zuul/src/github.com/osism/cfg-generics/./requirements.txt 2025-05-20 22:20:57.260302 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/Makefile to /home/zuul/src/github.com/osism/cfg-generics/./Makefile 2025-05-20 22:20:57.260644 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/images.yml to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/images.yml 2025-05-20 22:20:57.261204 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/run.sh to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/run.sh 2025-05-20 22:20:57.261611 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/ansible.cfg to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ansible.cfg 2025-05-20 22:20:57.263128 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/requirements.txt to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:57.263596 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/src/render-images.py to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:57.263972 | debian-bookworm | - copied (main) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/src/set-versions.py to /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-20 22:20:57.264206 | debian-bookworm | - running `python3 render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:58.243699 | debian-bookworm | - running `rm render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:58.256318 | debian-bookworm | - running `python3 set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-20 22:20:58.543869 | debian-bookworm | - running `rm set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-20 22:20:58.812491 | debian-bookworm | osism.cfg-generics: 2025-05-20 22:20:58.880917 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/gilt.yml to /home/zuul/src/github.com/osism/cfg-generics/./gilt.yml 2025-05-20 22:20:58.880973 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/requirements.txt to /home/zuul/src/github.com/osism/cfg-generics/./requirements.txt 2025-05-20 22:20:58.880986 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/Makefile to /home/zuul/src/github.com/osism/cfg-generics/./Makefile 2025-05-20 22:20:58.880995 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/images.yml to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/images.yml 2025-05-20 22:20:58.881350 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/run.sh to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/run.sh 2025-05-20 22:20:58.881723 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/ansible.cfg to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ansible.cfg 2025-05-20 22:20:58.882920 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/environments/manager/requirements.txt to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:58.883502 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/src/render-images.py to /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:58.884138 | debian-bookworm | - copied (v0.20250428.0) /home/zuul/.gilt/clone/github.com/osism.cfg-generics/src/set-versions.py to /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-20 22:20:58.884159 | debian-bookworm | - running `python3 render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:59.302062 | debian-bookworm | - running `rm render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-20 22:20:59.315318 | debian-bookworm | - running `python3 set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-20 22:20:59.597196 | debian-bookworm | - running `rm set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-20 22:20:59.693045 | debian-bookworm | gilt: 16905 I exit 0 (16.65 seconds) /home/zuul/src/github.com/osism/cfg-generics> make sync pid=1463 [tox/execute/api.py:294] 2025-05-20 22:20:59.695288 | debian-bookworm | gilt: OK (16.70=setup[0.04]+cmd[16.65] seconds) 2025-05-20 22:20:59.695335 | debian-bookworm | congratulations :) (16.77 seconds) 2025-05-20 22:20:59.997034 | debian-bookworm | ok: Runtime: 0:00:16.998464 2025-05-20 22:21:00.012221 | 2025-05-20 22:21:00.012391 | TASK [tox : Look for output] 2025-05-20 22:21:00.414049 | debian-bookworm | ok 2025-05-20 22:21:00.430384 | 2025-05-20 22:21:00.430520 | TASK [tox : Return file comments to Zuul] 2025-05-20 22:21:00.475319 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:00.493016 | 2025-05-20 22:21:00.493208 | PLAY RECAP 2025-05-20 22:21:00.493344 | debian-bookworm | ok: 12 changed: 8 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 0 2025-05-20 22:21:00.493406 | 2025-05-20 22:21:00.633760 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2025-05-20 22:21:00.636441 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2025-05-20 22:21:01.400626 | 2025-05-20 22:21:01.400836 | PLAY [all] 2025-05-20 22:21:01.430070 | 2025-05-20 22:21:01.430336 | TASK [fetch-tox-output : Set tox log path for multiple nodes] 2025-05-20 22:21:01.488237 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:01.496294 | 2025-05-20 22:21:01.496489 | TASK [fetch-tox-output : Set tox log path for single node] 2025-05-20 22:21:01.555946 | debian-bookworm | ok 2025-05-20 22:21:01.565537 | 2025-05-20 22:21:01.565868 | TASK [fetch-tox-output : Ensure local tox dir] 2025-05-20 22:21:02.051598 | debian-bookworm -> localhost | changed 2025-05-20 22:21:02.067593 | 2025-05-20 22:21:02.067785 | TASK [fetch-tox-output : Ensure zuul-output tox dir] 2025-05-20 22:21:02.123450 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:02.137021 | 2025-05-20 22:21:02.137211 | TASK [fetch-tox-output : Set envlist fact] 2025-05-20 22:21:02.184246 | debian-bookworm | ok 2025-05-20 22:21:02.193013 | 2025-05-20 22:21:02.193157 | TASK [fetch-tox-output : Get tox version] 2025-05-20 22:21:02.873339 | debian-bookworm | ROOT: No tox.ini or setup.cfg or pyproject.toml or tox.toml found, assuming empty tox.ini at /home/zuul 2025-05-20 22:21:02.892301 | debian-bookworm | 4.26.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2025-05-20 22:21:03.228632 | debian-bookworm | ok: Runtime: 0:00:00.311772 2025-05-20 22:21:03.241395 | 2025-05-20 22:21:03.241556 | TASK [fetch-tox-output : Find all default environments] 2025-05-20 22:21:03.775626 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:03.789097 | 2025-05-20 22:21:03.789285 | TASK [fetch-tox-output : Set envlist fact] 2025-05-20 22:21:03.836765 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:03.849810 | 2025-05-20 22:21:03.850008 | TASK [fetch-tox-output : Find all default environments] 2025-05-20 22:21:04.395234 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:04.408231 | 2025-05-20 22:21:04.408412 | TASK [fetch-tox-output : Set envlist fact] 2025-05-20 22:21:04.445728 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:04.461196 | 2025-05-20 22:21:04.461359 | LOOP [fetch-tox-output : Copy tox logs] 2025-05-20 22:21:04.517243 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:04.533962 | 2025-05-20 22:21:04.534128 | LOOP [fetch-tox-output : Collect tox logs] 2025-05-20 22:21:05.355250 | debian-bookworm | changed: 2025-05-20 22:21:05.355547 | debian-bookworm | created directory /var/lib/zuul/builds/40d49be7ce7d462681a40fdf91c6191b/work/logs/tox/gilt 2025-05-20 22:21:05.355611 | debian-bookworm | cd+++++++++ ./ 2025-05-20 22:21:05.355719 | debian-bookworm | >f+++++++++ 1-commands[0].log 2025-05-20 22:21:05.355777 | 2025-05-20 22:21:05.376664 | 2025-05-20 22:21:05.376799 | PLAY RECAP 2025-05-20 22:21:05.376881 | debian-bookworm | ok: 5 changed: 3 unreachable: 0 failed: 0 skipped: 7 rescued: 0 ignored: 0 2025-05-20 22:21:05.376920 | 2025-05-20 22:21:05.501928 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2025-05-20 22:21:05.504604 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2025-05-20 22:21:06.251096 | 2025-05-20 22:21:06.251259 | PLAY [all] 2025-05-20 22:21:06.267097 | 2025-05-20 22:21:06.267243 | TASK [fetch-subunit-output : Find stestr or testr executable] 2025-05-20 22:21:06.527546 | debian-bookworm | changed: non-zero return code 2025-05-20 22:21:06.536307 | 2025-05-20 22:21:06.536475 | TASK [fetch-subunit-output : Get the list of directories with subunit files] 2025-05-20 22:21:06.571594 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:06.584658 | 2025-05-20 22:21:06.584835 | LOOP [fetch-subunit-output : Find any inflight partial subunit files] 2025-05-20 22:21:06.624619 | 2025-05-20 22:21:06.624918 | LOOP [fetch-subunit-output : Copy any inflight subunit files] 2025-05-20 22:21:06.665885 | 2025-05-20 22:21:06.666187 | TASK [fetch-subunit-output : Create a temporary file to store the subunit stream] 2025-05-20 22:21:06.691779 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:06.701008 | 2025-05-20 22:21:06.701189 | LOOP [fetch-subunit-output : Generate subunit file] 2025-05-20 22:21:06.737072 | 2025-05-20 22:21:06.737382 | TASK [fetch-subunit-output : Copy the combined subunit file to the zuul work directory] 2025-05-20 22:21:06.762894 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:06.770233 | 2025-05-20 22:21:06.770379 | TASK [fetch-subunit-output : Remove the temporary file] 2025-05-20 22:21:06.796587 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:06.809132 | 2025-05-20 22:21:06.809308 | TASK [fetch-subunit-output : Process and fetch subunit results] 2025-05-20 22:21:06.834096 | debian-bookworm | skipping: Conditional result was False 2025-05-20 22:21:06.848146 | 2025-05-20 22:21:06.848292 | PLAY RECAP 2025-05-20 22:21:06.848384 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 8 rescued: 0 ignored: 0 2025-05-20 22:21:06.848431 | 2025-05-20 22:21:06.999605 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2025-05-20 22:21:07.002351 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2025-05-20 22:21:07.771740 | 2025-05-20 22:21:07.771909 | PLAY [Base post] 2025-05-20 22:21:07.786098 | 2025-05-20 22:21:07.786244 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2025-05-20 22:21:08.323031 | debian-bookworm | changed 2025-05-20 22:21:08.334701 | 2025-05-20 22:21:08.334865 | PLAY RECAP 2025-05-20 22:21:08.334949 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-05-20 22:21:08.335028 | 2025-05-20 22:21:08.451059 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2025-05-20 22:21:08.452970 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2025-05-20 22:21:09.274447 | 2025-05-20 22:21:09.275466 | PLAY [Base post-logs] 2025-05-20 22:21:09.287613 | 2025-05-20 22:21:09.287783 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2025-05-20 22:21:09.772296 | localhost | changed 2025-05-20 22:21:09.782728 | 2025-05-20 22:21:09.782903 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2025-05-20 22:21:09.819548 | localhost | ok 2025-05-20 22:21:09.824198 | 2025-05-20 22:21:09.824334 | TASK [Set zuul-log-path fact] 2025-05-20 22:21:09.841981 | localhost | ok 2025-05-20 22:21:09.856944 | 2025-05-20 22:21:09.857088 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-05-20 22:21:09.883079 | localhost | ok 2025-05-20 22:21:09.887934 | 2025-05-20 22:21:09.888051 | TASK [upload-logs : Create log directories] 2025-05-20 22:21:10.392220 | localhost | changed 2025-05-20 22:21:10.398449 | 2025-05-20 22:21:10.398699 | TASK [upload-logs : Ensure logs are readable before uploading] 2025-05-20 22:21:11.014407 | localhost -> localhost | ok: Runtime: 0:00:00.007386 2025-05-20 22:21:11.025367 | 2025-05-20 22:21:11.025595 | TASK [upload-logs : Upload logs to log server] 2025-05-20 22:21:11.651954 | localhost | Output suppressed because no_log was given 2025-05-20 22:21:11.654039 | 2025-05-20 22:21:11.654275 | LOOP [upload-logs : Compress console log and json output] 2025-05-20 22:21:11.704717 | localhost | skipping: Conditional result was False 2025-05-20 22:21:11.711374 | localhost | skipping: Conditional result was False 2025-05-20 22:21:11.725715 | 2025-05-20 22:21:11.725981 | LOOP [upload-logs : Upload compressed console log and json output] 2025-05-20 22:21:11.773769 | localhost | skipping: Conditional result was False 2025-05-20 22:21:11.774054 | 2025-05-20 22:21:11.779781 | localhost | skipping: Conditional result was False 2025-05-20 22:21:11.783818 | 2025-05-20 22:21:11.783932 | LOOP [upload-logs : Upload console log and json output]