2025-05-22 03:11:55.174760 | Job console starting 2025-05-22 03:11:55.214949 | Updating git repos 2025-05-22 03:11:55.273974 | Cloning repos into workspace 2025-05-22 03:11:55.318425 | Restoring repo states 2025-05-22 03:11:55.348374 | Merging changes 2025-05-22 03:11:55.348399 | Checking out repos 2025-05-22 03:11:55.451005 | Preparing playbooks 2025-05-22 03:11:56.901394 | Running Ansible setup 2025-05-22 03:12:03.375254 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-05-22 03:12:05.318255 | 2025-05-22 03:12:05.318427 | PLAY [Base pre] 2025-05-22 03:12:05.337532 | 2025-05-22 03:12:05.337742 | TASK [Setup log path fact] 2025-05-22 03:12:05.393965 | debian-bookworm | ok 2025-05-22 03:12:05.414360 | 2025-05-22 03:12:05.414532 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-05-22 03:12:05.446051 | debian-bookworm | ok 2025-05-22 03:12:05.458728 | 2025-05-22 03:12:05.458940 | TASK [emit-job-header : Print job information] 2025-05-22 03:12:05.520512 | # Job Information 2025-05-22 03:12:05.520786 | Ansible Version: 2.16.14 2025-05-22 03:12:05.520828 | Job: cfg-generics-tox-gilt 2025-05-22 03:12:05.520870 | Pipeline: periodic-daily 2025-05-22 03:12:05.520899 | Executor: 521e9411259a 2025-05-22 03:12:05.520920 | Triggered by: https://github.com/osism/cfg-generics 2025-05-22 03:12:05.520942 | Event ID: 7ab3c84d19b94daca6eb9d52e72e1aae 2025-05-22 03:12:05.529398 | 2025-05-22 03:12:05.529797 | LOOP [emit-job-header : Print node information] 2025-05-22 03:12:05.958617 | debian-bookworm | ok: 2025-05-22 03:12:05.958967 | debian-bookworm | # Node Information 2025-05-22 03:12:05.959011 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-05-22 03:12:05.959037 | debian-bookworm | Hostname: debian 2025-05-22 03:12:05.959059 | debian-bookworm | Username: zuul 2025-05-22 03:12:05.959080 | debian-bookworm | Distro: Debian 12.11 2025-05-22 03:12:05.959103 | debian-bookworm | Provider: regiocloud-a 2025-05-22 03:12:05.959124 | debian-bookworm | Region: 2025-05-22 03:12:05.959145 | debian-bookworm | Label: debian-bookworm 2025-05-22 03:12:05.959165 | debian-bookworm | Product Name: OpenStack Nova 2025-05-22 03:12:05.959184 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fefe:7130 2025-05-22 03:12:05.996051 | 2025-05-22 03:12:05.996206 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-05-22 03:12:07.480595 | debian-bookworm -> localhost | changed 2025-05-22 03:12:07.488343 | 2025-05-22 03:12:07.488503 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-05-22 03:12:09.449638 | debian-bookworm -> localhost | changed 2025-05-22 03:12:09.468714 | 2025-05-22 03:12:09.468821 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-05-22 03:12:09.971865 | debian-bookworm -> localhost | ok 2025-05-22 03:12:09.978221 | 2025-05-22 03:12:09.978319 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-05-22 03:12:09.996325 | debian-bookworm | ok 2025-05-22 03:12:10.015546 | debian-bookworm | included: /var/lib/zuul/builds/36fb46fc42944a30acf95f19ce716874/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-05-22 03:12:10.021422 | 2025-05-22 03:12:10.021510 | TASK [add-build-sshkey : Create Temp SSH key] 2025-05-22 03:12:12.431508 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-05-22 03:12:12.431726 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/36fb46fc42944a30acf95f19ce716874/work/36fb46fc42944a30acf95f19ce716874_id_rsa 2025-05-22 03:12:12.431769 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/36fb46fc42944a30acf95f19ce716874/work/36fb46fc42944a30acf95f19ce716874_id_rsa.pub 2025-05-22 03:12:12.431797 | debian-bookworm -> localhost | The key fingerprint is: 2025-05-22 03:12:12.431822 | debian-bookworm -> localhost | SHA256:VaLmQtdPI4M5HLNdS52g+tcrSCgHjL/MBGvdKhQjzrk zuul-build-sshkey 2025-05-22 03:12:12.431844 | debian-bookworm -> localhost | The key's randomart image is: 2025-05-22 03:12:12.431873 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-05-22 03:12:12.431895 | debian-bookworm -> localhost | | o . =o . | 2025-05-22 03:12:12.431916 | debian-bookworm -> localhost | | . X * .o | 2025-05-22 03:12:12.431936 | debian-bookworm -> localhost | | o. X B + | 2025-05-22 03:12:12.431955 | debian-bookworm -> localhost | | . =.o+ + = . | 2025-05-22 03:12:12.431975 | debian-bookworm -> localhost | | o o B.oS. . | 2025-05-22 03:12:12.432001 | debian-bookworm -> localhost | | + + =.+.. . | 2025-05-22 03:12:12.432021 | debian-bookworm -> localhost | | + + = .... . | 2025-05-22 03:12:12.432040 | debian-bookworm -> localhost | | E . = ... . | 2025-05-22 03:12:12.432060 | debian-bookworm -> localhost | | . .. | 2025-05-22 03:12:12.432117 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-05-22 03:12:12.432174 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.643531 2025-05-22 03:12:12.438948 | 2025-05-22 03:12:12.439035 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-05-22 03:12:12.476556 | debian-bookworm | ok 2025-05-22 03:12:12.485889 | debian-bookworm | included: /var/lib/zuul/builds/36fb46fc42944a30acf95f19ce716874/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-05-22 03:12:12.514891 | 2025-05-22 03:12:12.514997 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-05-22 03:12:12.561429 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:12:12.568934 | 2025-05-22 03:12:12.569052 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-05-22 03:12:13.263858 | debian-bookworm | changed 2025-05-22 03:12:13.269674 | 2025-05-22 03:12:13.269780 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-05-22 03:12:13.540303 | debian-bookworm | ok 2025-05-22 03:12:13.550317 | 2025-05-22 03:12:13.550421 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-05-22 03:12:14.179223 | debian-bookworm | changed 2025-05-22 03:12:14.186772 | 2025-05-22 03:12:14.186886 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-05-22 03:12:14.873430 | debian-bookworm | changed 2025-05-22 03:12:14.882201 | 2025-05-22 03:12:14.882335 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-05-22 03:12:14.905850 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:12:14.912399 | 2025-05-22 03:12:14.912517 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-05-22 03:12:15.675754 | debian-bookworm -> localhost | changed 2025-05-22 03:12:15.695368 | 2025-05-22 03:12:15.695723 | TASK [add-build-sshkey : Add back temp key] 2025-05-22 03:12:16.167052 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/36fb46fc42944a30acf95f19ce716874/work/36fb46fc42944a30acf95f19ce716874_id_rsa (zuul-build-sshkey) 2025-05-22 03:12:16.167310 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.015500 2025-05-22 03:12:16.176886 | 2025-05-22 03:12:16.177007 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-05-22 03:12:16.706190 | debian-bookworm | ok 2025-05-22 03:12:16.712133 | 2025-05-22 03:12:16.712260 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-05-22 03:12:16.771495 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:12:16.783066 | 2025-05-22 03:12:16.783195 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-05-22 03:12:17.270796 | debian-bookworm | ok 2025-05-22 03:12:17.282557 | 2025-05-22 03:12:17.282704 | TASK [validate-host : Define zuul_info_dir fact] 2025-05-22 03:12:17.320337 | debian-bookworm | ok 2025-05-22 03:12:17.325752 | 2025-05-22 03:12:17.325859 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-05-22 03:12:17.648566 | debian-bookworm -> localhost | ok 2025-05-22 03:12:17.655686 | 2025-05-22 03:12:17.655804 | TASK [validate-host : Collect information about the host] 2025-05-22 03:12:19.045682 | debian-bookworm | ok 2025-05-22 03:12:19.117805 | 2025-05-22 03:12:19.117958 | TASK [validate-host : Sanitize hostname] 2025-05-22 03:12:19.248474 | debian-bookworm | ok 2025-05-22 03:12:19.370405 | 2025-05-22 03:12:19.370548 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-05-22 03:12:20.529913 | debian-bookworm -> localhost | changed 2025-05-22 03:12:20.537523 | 2025-05-22 03:12:20.537691 | TASK [validate-host : Collect information about zuul worker] 2025-05-22 03:12:21.180742 | debian-bookworm | ok 2025-05-22 03:12:21.188454 | 2025-05-22 03:12:21.189034 | TASK [validate-host : Write out all zuul information for each host] 2025-05-22 03:12:22.604410 | debian-bookworm -> localhost | changed 2025-05-22 03:12:22.614444 | 2025-05-22 03:12:22.614563 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-05-22 03:12:22.907094 | debian-bookworm | ok 2025-05-22 03:12:22.913102 | 2025-05-22 03:12:22.913218 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-05-22 03:12:24.050603 | debian-bookworm | changed: 2025-05-22 03:12:24.050875 | debian-bookworm | cd+++++++++ src/ 2025-05-22 03:12:24.050913 | debian-bookworm | cd+++++++++ src/github.com/ 2025-05-22 03:12:24.050938 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-05-22 03:12:24.050961 | debian-bookworm | cd+++++++++ src/github.com/osism/cfg-generics/ 2025-05-22 03:12:24.050982 | debian-bookworm | =5.5.1 2025-05-22 03:12:46.115535 | debian-bookworm | Downloading cachetools-5.5.2-py3-none-any.whl (10 kB) 2025-05-22 03:12:46.145368 | debian-bookworm | Collecting chardet>=5.2 2025-05-22 03:12:46.152564 | debian-bookworm | Downloading chardet-5.2.0-py3-none-any.whl (199 kB) 2025-05-22 03:12:46.169516 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 199.4/199.4 kB 13.9 MB/s eta 0:00:00 2025-05-22 03:12:46.201838 | debian-bookworm | Collecting colorama>=0.4.6 2025-05-22 03:12:46.209490 | debian-bookworm | Downloading colorama-0.4.6-py2.py3-none-any.whl (25 kB) 2025-05-22 03:12:46.276342 | debian-bookworm | Collecting filelock>=3.16.1 2025-05-22 03:12:46.285327 | debian-bookworm | Downloading filelock-3.18.0-py3-none-any.whl (16 kB) 2025-05-22 03:12:46.366296 | debian-bookworm | Collecting packaging>=24.2 2025-05-22 03:12:46.374179 | debian-bookworm | Downloading packaging-25.0-py3-none-any.whl (66 kB) 2025-05-22 03:12:46.384817 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 66.5/66.5 kB 7.6 MB/s eta 0:00:00 2025-05-22 03:12:46.427576 | debian-bookworm | Collecting platformdirs>=4.3.6 2025-05-22 03:12:46.435680 | debian-bookworm | Downloading platformdirs-4.3.8-py3-none-any.whl (18 kB) 2025-05-22 03:12:46.485224 | debian-bookworm | Collecting pluggy>=1.5 2025-05-22 03:12:46.492599 | debian-bookworm | Downloading pluggy-1.6.0-py3-none-any.whl (20 kB) 2025-05-22 03:12:46.526480 | debian-bookworm | Collecting pyproject-api>=1.8 2025-05-22 03:12:46.534661 | debian-bookworm | Downloading pyproject_api-1.9.1-py3-none-any.whl (13 kB) 2025-05-22 03:12:46.654181 | debian-bookworm | Collecting virtualenv>=20.31 2025-05-22 03:12:46.661665 | debian-bookworm | Downloading virtualenv-20.31.2-py3-none-any.whl (6.1 MB) 2025-05-22 03:12:46.946919 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 6.1/6.1 MB 21.6 MB/s eta 0:00:00 2025-05-22 03:12:47.057913 | debian-bookworm | Collecting distlib<1,>=0.3.7 2025-05-22 03:12:47.065332 | debian-bookworm | Downloading distlib-0.3.9-py2.py3-none-any.whl (468 kB) 2025-05-22 03:12:47.097197 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 469.0/469.0 kB 17.1 MB/s eta 0:00:00 2025-05-22 03:12:47.262739 | debian-bookworm | Installing collected packages: distlib, pluggy, platformdirs, packaging, filelock, colorama, chardet, cachetools, virtualenv, pyproject-api, tox 2025-05-22 03:12:48.119491 | 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-22 03:12:48.547823 | debian-bookworm | ok: Runtime: 0:00:02.919829 2025-05-22 03:12:48.554066 | 2025-05-22 03:12:48.554180 | TASK [ensure-tox : Export installed tox_executable path] 2025-05-22 03:12:48.605969 | debian-bookworm | ok 2025-05-22 03:12:48.616510 | 2025-05-22 03:12:48.616664 | TASK [ensure-tox : Output tox version] 2025-05-22 03:12:49.186155 | 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-22 03:12:49.208690 | debian-bookworm | 4.26.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2025-05-22 03:12:49.668097 | debian-bookworm | ok: Runtime: 0:00:00.304420 2025-05-22 03:12:49.674813 | 2025-05-22 03:12:49.674950 | TASK [ensure-tox : Make global symlink] 2025-05-22 03:12:49.699291 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:12:49.706354 | 2025-05-22 03:12:49.706446 | PLAY RECAP 2025-05-22 03:12:49.706500 | debian-bookworm | ok: 13 changed: 9 unreachable: 0 failed: 0 skipped: 14 rescued: 0 ignored: 0 2025-05-22 03:12:49.706538 | 2025-05-22 03:12:49.871998 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/pre.yaml@master] 2025-05-22 03:12:49.873158 | RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2025-05-22 03:12:50.750072 | 2025-05-22 03:12:50.750251 | PLAY [all] 2025-05-22 03:12:50.771942 | 2025-05-22 03:12:50.772107 | TASK [revoke-sudo : Check if zuul is sudoer] 2025-05-22 03:12:51.238023 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2025-05-22 03:12:51.303555 | debian-bookworm | ok: Runtime: 0:00:00.029431 2025-05-22 03:12:51.309653 | 2025-05-22 03:12:51.309793 | TASK [revoke-sudo : Remove sudo access for zuul user.] 2025-05-22 03:12:51.846159 | debian-bookworm | ok: Runtime: 0:00:00.006722 2025-05-22 03:12:51.864518 | 2025-05-22 03:12:51.864984 | TASK [revoke-sudo : Prove that general sudo access is actually revoked.] 2025-05-22 03:12:52.218937 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2025-05-22 03:12:52.221407 | debian-bookworm | sudo: a password is required 2025-05-22 03:12:52.440480 | debian-bookworm | ok: Runtime: 0:00:00.021796 2025-05-22 03:12:52.466161 | 2025-05-22 03:12:52.466910 | TASK [tox : Check to see if the constraints file exists] 2025-05-22 03:12:52.515070 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:12:52.539772 | 2025-05-22 03:12:52.539953 | TASK [tox : Fail if constraints file is missing] 2025-05-22 03:12:52.589124 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:12:52.597892 | 2025-05-22 03:12:52.598029 | TASK [tox : Record file location] 2025-05-22 03:12:52.637428 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:12:52.648486 | 2025-05-22 03:12:52.648687 | TASK [tox : Install tox siblings] 2025-05-22 03:12:52.700065 | debian-bookworm | ok 2025-05-22 03:12:52.728103 | debian-bookworm | included: /var/lib/zuul/builds/36fb46fc42944a30acf95f19ce716874/untrusted/project_0/github.com/osism/openinfra-zuul-jobs/roles/tox/tasks/siblings.yaml 2025-05-22 03:12:52.743578 | 2025-05-22 03:12:52.744928 | TASK [tox : Run tox without tests] 2025-05-22 03:12:53.272707 | debian-bookworm | ROOT: 138 D setup logging to DEBUG on pid 1426 [tox/report.py:222] 2025-05-22 03:12:53.343142 | debian-bookworm | gilt: 208 D created app data folder /home/zuul/.local/share/virtualenv [virtualenv/app_data/__init__.py:42] 2025-05-22 03:12:53.345937 | debian-bookworm | gilt: 211 I find interpreter for spec PythonSpec(path=/home/zuul/.local/tox/bin/python3) [virtualenv/discovery/builtin.py:76] 2025-05-22 03:12:53.346378 | debian-bookworm | gilt: 212 D filesystem is case-sensitive [virtualenv/info.py:27] 2025-05-22 03:12:53.347271 | debian-bookworm | gilt: 213 D get interpreter info via cmd: /usr/bin/python3.11 /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/discovery/py_info.py vrZBqoNwzmsrGrArGzkWXOcLW4rd9Cvj UaSBvlq1Te2EafYBIH12VqJVOZDXwygt [virtualenv/discovery/cached_py_info.py:117] 2025-05-22 03:12:53.404880 | debian-bookworm | gilt: 270 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-22 03:12:53.404952 | debian-bookworm | gilt: 270 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-22 03:12:53.405067 | debian-bookworm | gilt: 270 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-22 03:12:53.434703 | debian-bookworm | gilt: 300 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-22 03:12:53.434987 | debian-bookworm | gilt: 300 D create folder /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/bin [virtualenv/util/path/_sync.py:14] 2025-05-22 03:12:53.435071 | debian-bookworm | gilt: 300 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-22 03:12:53.435253 | debian-bookworm | gilt: 301 D write /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/pyvenv.cfg [virtualenv/create/pyenv_cfg.py:35] 2025-05-22 03:12:53.435304 | debian-bookworm | gilt: 301 D home = /usr/bin [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.435356 | debian-bookworm | gilt: 301 D implementation = CPython [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.435402 | debian-bookworm | gilt: 301 D version_info = 3.11.2.final.0 [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.435448 | debian-bookworm | gilt: 301 D virtualenv = 20.31.2 [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.435493 | debian-bookworm | gilt: 301 D include-system-site-packages = false [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.435570 | debian-bookworm | gilt: 301 D base-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.435625 | debian-bookworm | gilt: 301 D base-exec-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.435759 | debian-bookworm | gilt: 301 D base-executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.436002 | debian-bookworm | gilt: 301 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-22 03:12:53.436307 | debian-bookworm | gilt: 302 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-22 03:12:53.436443 | debian-bookworm | gilt: 302 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-22 03:12:53.436881 | debian-bookworm | gilt: 302 D ============================== target debug ============================== [virtualenv/run/session.py:54] 2025-05-22 03:12:53.437121 | debian-bookworm | gilt: 303 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-22 03:12:53.477951 | debian-bookworm | gilt: 302 D { 2025-05-22 03:12:53.477995 | debian-bookworm | "sys": { 2025-05-22 03:12:53.478001 | debian-bookworm | "executable": "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/bin/python", 2025-05-22 03:12:53.478007 | debian-bookworm | "_base_executable": "/usr/bin/python3.11", 2025-05-22 03:12:53.478013 | debian-bookworm | "prefix": "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt", 2025-05-22 03:12:53.478018 | debian-bookworm | "base_prefix": "/usr", 2025-05-22 03:12:53.478023 | debian-bookworm | "real_prefix": null, 2025-05-22 03:12:53.478028 | debian-bookworm | "exec_prefix": "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt", 2025-05-22 03:12:53.478034 | debian-bookworm | "base_exec_prefix": "/usr", 2025-05-22 03:12:53.478038 | debian-bookworm | "path": [ 2025-05-22 03:12:53.478044 | debian-bookworm | "/usr/lib/python311.zip", 2025-05-22 03:12:53.478048 | debian-bookworm | "/usr/lib/python3.11", 2025-05-22 03:12:53.478052 | debian-bookworm | "/usr/lib/python3.11/lib-dynload", 2025-05-22 03:12:53.478056 | debian-bookworm | "/home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/lib/python3.11/site-packages" 2025-05-22 03:12:53.478060 | debian-bookworm | ], 2025-05-22 03:12:53.478064 | debian-bookworm | "meta_path": [ 2025-05-22 03:12:53.478068 | debian-bookworm | "", 2025-05-22 03:12:53.478072 | debian-bookworm | "", 2025-05-22 03:12:53.478077 | debian-bookworm | "", 2025-05-22 03:12:53.478080 | debian-bookworm | "" 2025-05-22 03:12:53.478084 | debian-bookworm | ], 2025-05-22 03:12:53.478088 | debian-bookworm | "fs_encoding": "utf-8", 2025-05-22 03:12:53.478092 | debian-bookworm | "io_encoding": "utf-8" 2025-05-22 03:12:53.478096 | debian-bookworm | }, 2025-05-22 03:12:53.478100 | debian-bookworm | "version": "3.11.2 (main, Apr 28 2025, 14:11:48) [GCC 12.2.0]", 2025-05-22 03:12:53.478104 | debian-bookworm | "makefile_filename": "/usr/lib/python3.11/config-3.11-x86_64-linux-gnu/Makefile", 2025-05-22 03:12:53.478108 | debian-bookworm | "os": "", 2025-05-22 03:12:53.478112 | debian-bookworm | "site": "", 2025-05-22 03:12:53.478115 | debian-bookworm | "datetime": "", 2025-05-22 03:12:53.478119 | debian-bookworm | "math": "", 2025-05-22 03:12:53.478123 | debian-bookworm | "json": "" 2025-05-22 03:12:53.478127 | debian-bookworm | } [virtualenv/run/session.py:55] 2025-05-22 03:12:53.478140 | debian-bookworm | gilt: 343 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-22 03:12:53.479625 | debian-bookworm | gilt: 345 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-22 03:12:53.480128 | debian-bookworm | gilt: 345 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-22 03:12:53.481246 | debian-bookworm | gilt: 347 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-22 03:12:53.481395 | debian-bookworm | gilt: 347 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-22 03:12:53.741299 | debian-bookworm | gilt: 607 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-22 03:12:53.747421 | debian-bookworm | gilt: 613 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-22 03:12:53.747731 | debian-bookworm | gilt: 613 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-22 03:12:53.749466 | debian-bookworm | gilt: 615 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-22 03:12:53.749751 | debian-bookworm | gilt: 615 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-22 03:12:53.750692 | debian-bookworm | gilt: 616 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-22 03:12:53.780821 | debian-bookworm | gilt: 646 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-22 03:12:53.928422 | debian-bookworm | gilt: 794 D generated console scripts [virtualenv/seed/embed/via_app_data/pip_install/base.py:45] 2025-05-22 03:12:53.932871 | debian-bookworm | gilt: 798 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-22 03:12:53.933124 | debian-bookworm | gilt: 799 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-22 03:12:53.934441 | debian-bookworm | gilt: 800 D generated console scripts pip-3.11 pip3.11 pip3 pip [virtualenv/seed/embed/via_app_data/pip_install/base.py:45] 2025-05-22 03:12:53.934926 | debian-bookworm | gilt: 800 I add activators for Bash, CShell, Fish, Nushell, PowerShell, Python [virtualenv/run/session.py:65] 2025-05-22 03:12:53.944116 | debian-bookworm | gilt: 809 D write /home/zuul/src/github.com/osism/cfg-generics/.tox/gilt/pyvenv.cfg [virtualenv/create/pyenv_cfg.py:35] 2025-05-22 03:12:53.944327 | debian-bookworm | gilt: 810 D home = /usr/bin [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.944460 | debian-bookworm | gilt: 810 D implementation = CPython [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.944634 | debian-bookworm | gilt: 810 D version_info = 3.11.2.final.0 [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.944782 | debian-bookworm | gilt: 810 D virtualenv = 20.31.2 [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.944903 | debian-bookworm | gilt: 810 D include-system-site-packages = false [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.945039 | debian-bookworm | gilt: 810 D base-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.945169 | debian-bookworm | gilt: 811 D base-exec-prefix = /usr [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.945378 | debian-bookworm | gilt: 811 D base-executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:40] 2025-05-22 03:12:53.948383 | debian-bookworm | gilt: OK (0.61 seconds) 2025-05-22 03:12:53.948403 | debian-bookworm | congratulations :) (0.68 seconds) 2025-05-22 03:12:54.302360 | debian-bookworm | ok: Runtime: 0:00:00.902783 2025-05-22 03:12:54.316636 | 2025-05-22 03:12:54.316758 | TASK [tox : Create a tempfile to save tox showconfig] 2025-05-22 03:12:54.939520 | debian-bookworm | changed 2025-05-22 03:12:54.945942 | 2025-05-22 03:12:54.946069 | TASK [tox : Get tox envlist config] 2025-05-22 03:12:55.978361 | debian-bookworm | ok: Runtime: 0:00:00.318526 2025-05-22 03:12:55.984717 | 2025-05-22 03:12:55.984841 | TASK [tox : Install any sibling python packages] 2025-05-22 03:12:56.586336 | debian-bookworm | ok: No setup.cfg, no action needed 2025-05-22 03:12:56.594828 | 2025-05-22 03:12:56.595018 | TASK [tox : Remove tempfile] 2025-05-22 03:12:57.060466 | debian-bookworm | changed 2025-05-22 03:12:57.067691 | 2025-05-22 03:12:57.067834 | TASK [tox : Emit tox command] 2025-05-22 03:12:57.131096 | /home/zuul/.local/tox/bin/tox -egilt -vv --skip-missing-interpreters=false 2025-05-22 03:12:57.138156 | 2025-05-22 03:12:57.138307 | TASK [tox : Run tox] 2025-05-22 03:12:57.744246 | debian-bookworm | ROOT: 139 D setup logging to DEBUG on pid 1459 [tox/report.py:222] 2025-05-22 03:12:57.817540 | debian-bookworm | gilt: 212 I find interpreter for spec PythonSpec(path=/home/zuul/.local/tox/bin/python3) [virtualenv/discovery/builtin.py:76] 2025-05-22 03:12:57.817991 | debian-bookworm | gilt: 213 D filesystem is case-sensitive [virtualenv/info.py:27] 2025-05-22 03:12:57.818779 | debian-bookworm | gilt: 214 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-22 03:12:57.819339 | debian-bookworm | gilt: 214 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-22 03:12:57.819423 | debian-bookworm | gilt: 214 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-22 03:12:57.848812 | debian-bookworm | gilt: 243 W commands[0]> make sync [tox/tox_env/api.py:435] 2025-05-22 03:12:57.859992 | debian-bookworm | INFO: the file VAULTPASS_FILE='/secrets/vaultpass' does not exist and no running 'osism-ansible' container 2025-05-22 03:12:57.865082 | debian-bookworm | basename: missing operand 2025-05-22 03:12:57.865138 | debian-bookworm | Try 'basename --help' for more information. 2025-05-22 03:13:02.909884 | debian-bookworm | Collecting uv 2025-05-22 03:13:02.972413 | debian-bookworm | Downloading uv-0.7.6-py3-none-manylinux_2_17_x86_64.manylinux2014_x86_64.whl (17.4 MB) 2025-05-22 03:13:03.802904 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 17.4/17.4 MB 19.2 MB/s eta 0:00:00 2025-05-22 03:13:03.885037 | debian-bookworm | Installing collected packages: uv 2025-05-22 03:13:04.222410 | debian-bookworm | Successfully installed uv-0.7.6 2025-05-22 03:13:04.431163 | debian-bookworm | Using Python 3.11.2 environment at: venv 2025-05-22 03:13:05.439217 | debian-bookworm | Resolved 22 packages in 1.00s 2025-05-22 03:13:05.443569 | debian-bookworm | Building pwgen==0.8.2.post0 2025-05-22 03:13:05.458929 | debian-bookworm | Downloading cryptography (4.3MiB) 2025-05-22 03:13:05.476698 | debian-bookworm | Downloading ansible (52.9MiB) 2025-05-22 03:13:05.482130 | debian-bookworm | Downloading ansible-core (2.1MiB) 2025-05-22 03:13:05.781368 | debian-bookworm | Downloading ansible-core 2025-05-22 03:13:05.858214 | debian-bookworm | Downloading cryptography 2025-05-22 03:13:06.317216 | debian-bookworm | Built pwgen==0.8.2.post0 2025-05-22 03:13:09.511056 | debian-bookworm | Downloading ansible 2025-05-22 03:13:09.517991 | debian-bookworm | Prepared 22 packages in 4.07s 2025-05-22 03:13:09.959270 | debian-bookworm | Installed 22 packages in 444ms 2025-05-22 03:13:09.959335 | debian-bookworm | + ansible==11.6.0 2025-05-22 03:13:09.959342 | debian-bookworm | + ansible-core==2.18.6 2025-05-22 03:13:09.959346 | debian-bookworm | + certifi==2025.4.26 2025-05-22 03:13:09.959351 | debian-bookworm | + cffi==1.17.1 2025-05-22 03:13:09.959355 | debian-bookworm | + charset-normalizer==3.4.2 2025-05-22 03:13:09.959359 | debian-bookworm | + click==8.2.1 2025-05-22 03:13:09.959365 | debian-bookworm | + colorama==0.4.6 2025-05-22 03:13:09.959370 | debian-bookworm | + cryptography==45.0.2 2025-05-22 03:13:09.959373 | debian-bookworm | + fasteners==0.19 2025-05-22 03:13:09.959378 | debian-bookworm | + idna==3.10 2025-05-22 03:13:09.959382 | debian-bookworm | + jinja2==3.1.6 2025-05-22 03:13:09.959386 | debian-bookworm | + markupsafe==3.0.2 2025-05-22 03:13:09.959412 | debian-bookworm | + packaging==25.0 2025-05-22 03:13:09.959419 | debian-bookworm | + pwgen==0.8.2.post0 2025-05-22 03:13:09.959424 | debian-bookworm | + pycparser==2.22 2025-05-22 03:13:09.959430 | debian-bookworm | + python-gilt==1.2.3 2025-05-22 03:13:09.959436 | debian-bookworm | + pyyaml==6.0.2 2025-05-22 03:13:09.959443 | debian-bookworm | + requests==2.32.3 2025-05-22 03:13:09.959449 | debian-bookworm | + resolvelib==1.0.1 2025-05-22 03:13:09.959455 | debian-bookworm | + sh==2.2.2 2025-05-22 03:13:09.959461 | debian-bookworm | + tabulate==0.9.0 2025-05-22 03:13:09.959468 | debian-bookworm | + urllib3==2.4.0 2025-05-22 03:13:09.968983 | debian-bookworm | touch venv/bin/activate 2025-05-22 03:13:10.364175 | debian-bookworm | osism.cfg-generics: 2025-05-22 03:13:10.364209 | debian-bookworm | - cloning osism.cfg-generics to /home/zuul/.gilt/clone/github.com/osism.cfg-generics 2025-05-22 03:13:11.863189 | 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-22 03:13:11.864453 | 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-22 03:13:11.865238 | 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-22 03:13:11.866187 | 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-22 03:13:11.867302 | 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-22 03:13:11.867865 | 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-22 03:13:11.869896 | 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-22 03:13:11.870824 | 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-22 03:13:11.871176 | 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-22 03:13:11.871537 | debian-bookworm | - running `python3 render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-22 03:13:12.823779 | debian-bookworm | - running `rm render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-22 03:13:12.834027 | debian-bookworm | - running `python3 set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-22 03:13:13.111444 | debian-bookworm | - running `rm set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-22 03:13:13.389827 | debian-bookworm | osism.cfg-generics: 2025-05-22 03:13:13.440796 | 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-22 03:13:13.440984 | 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-22 03:13:13.440997 | 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-22 03:13:13.441148 | 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-22 03:13:13.441283 | 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-22 03:13:13.441428 | 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-22 03:13:13.442021 | 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-22 03:13:13.442165 | 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-22 03:13:13.442292 | 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-22 03:13:13.442302 | debian-bookworm | - running `python3 render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-22 03:13:13.799857 | debian-bookworm | - running `rm render-images.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/manager/ 2025-05-22 03:13:13.807846 | debian-bookworm | - running `python3 set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-22 03:13:14.076637 | debian-bookworm | - running `rm set-versions.py` in /home/zuul/src/github.com/osism/cfg-generics/environments/ 2025-05-22 03:13:14.149256 | debian-bookworm | gilt: 16544 I exit 0 (16.30 seconds) /home/zuul/src/github.com/osism/cfg-generics> make sync pid=1466 [tox/execute/api.py:294] 2025-05-22 03:13:14.150133 | debian-bookworm | gilt: OK (16.34=setup[0.04]+cmd[16.30] seconds) 2025-05-22 03:13:14.150164 | debian-bookworm | congratulations :) (16.41 seconds) 2025-05-22 03:13:14.246922 | debian-bookworm | ok: Runtime: 0:00:16.634930 2025-05-22 03:13:14.253371 | 2025-05-22 03:13:14.253475 | TASK [tox : Look for output] 2025-05-22 03:13:14.646336 | debian-bookworm | ok 2025-05-22 03:13:14.659980 | 2025-05-22 03:13:14.660107 | TASK [tox : Return file comments to Zuul] 2025-05-22 03:13:14.694283 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:14.701275 | 2025-05-22 03:13:14.701376 | PLAY RECAP 2025-05-22 03:13:14.701433 | debian-bookworm | ok: 12 changed: 8 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 0 2025-05-22 03:13:14.701457 | 2025-05-22 03:13:14.864717 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2025-05-22 03:13:14.865838 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2025-05-22 03:13:15.615345 | 2025-05-22 03:13:15.615521 | PLAY [all] 2025-05-22 03:13:15.631318 | 2025-05-22 03:13:15.631552 | TASK [fetch-tox-output : Set tox log path for multiple nodes] 2025-05-22 03:13:15.696653 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:15.702718 | 2025-05-22 03:13:15.702912 | TASK [fetch-tox-output : Set tox log path for single node] 2025-05-22 03:13:15.752157 | debian-bookworm | ok 2025-05-22 03:13:15.757663 | 2025-05-22 03:13:15.757788 | TASK [fetch-tox-output : Ensure local tox dir] 2025-05-22 03:13:16.248502 | debian-bookworm -> localhost | changed 2025-05-22 03:13:16.260240 | 2025-05-22 03:13:16.260386 | TASK [fetch-tox-output : Ensure zuul-output tox dir] 2025-05-22 03:13:16.315066 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:16.321371 | 2025-05-22 03:13:16.321511 | TASK [fetch-tox-output : Set envlist fact] 2025-05-22 03:13:16.381490 | debian-bookworm | ok 2025-05-22 03:13:16.395829 | 2025-05-22 03:13:16.395972 | TASK [fetch-tox-output : Get tox version] 2025-05-22 03:13:17.120944 | 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-22 03:13:17.138814 | debian-bookworm | 4.26.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2025-05-22 03:13:17.453071 | debian-bookworm | ok: Runtime: 0:00:00.294525 2025-05-22 03:13:17.466675 | 2025-05-22 03:13:17.467039 | TASK [fetch-tox-output : Find all default environments] 2025-05-22 03:13:18.000784 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:18.007932 | 2025-05-22 03:13:18.008074 | TASK [fetch-tox-output : Set envlist fact] 2025-05-22 03:13:18.054361 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:18.060286 | 2025-05-22 03:13:18.060409 | TASK [fetch-tox-output : Find all default environments] 2025-05-22 03:13:18.593407 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:18.600109 | 2025-05-22 03:13:18.600245 | TASK [fetch-tox-output : Set envlist fact] 2025-05-22 03:13:18.634896 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:18.641521 | 2025-05-22 03:13:18.641655 | LOOP [fetch-tox-output : Copy tox logs] 2025-05-22 03:13:18.687224 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:18.703578 | 2025-05-22 03:13:18.703743 | LOOP [fetch-tox-output : Collect tox logs] 2025-05-22 03:13:19.526937 | debian-bookworm | changed: 2025-05-22 03:13:19.527148 | debian-bookworm | created directory /var/lib/zuul/builds/36fb46fc42944a30acf95f19ce716874/work/logs/tox/gilt 2025-05-22 03:13:19.527182 | debian-bookworm | cd+++++++++ ./ 2025-05-22 03:13:19.527207 | debian-bookworm | >f+++++++++ 1-commands[0].log 2025-05-22 03:13:19.527236 | 2025-05-22 03:13:19.535110 | 2025-05-22 03:13:19.535233 | PLAY RECAP 2025-05-22 03:13:19.535298 | debian-bookworm | ok: 5 changed: 3 unreachable: 0 failed: 0 skipped: 7 rescued: 0 ignored: 0 2025-05-22 03:13:19.535323 | 2025-05-22 03:13:19.707745 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2025-05-22 03:13:19.708788 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2025-05-22 03:13:20.549118 | 2025-05-22 03:13:20.549283 | PLAY [all] 2025-05-22 03:13:20.566083 | 2025-05-22 03:13:20.566245 | TASK [fetch-subunit-output : Find stestr or testr executable] 2025-05-22 03:13:20.791571 | debian-bookworm | changed: non-zero return code 2025-05-22 03:13:20.798323 | 2025-05-22 03:13:20.798530 | TASK [fetch-subunit-output : Get the list of directories with subunit files] 2025-05-22 03:13:20.823689 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:20.830358 | 2025-05-22 03:13:20.830493 | LOOP [fetch-subunit-output : Find any inflight partial subunit files] 2025-05-22 03:13:20.860765 | 2025-05-22 03:13:20.860955 | LOOP [fetch-subunit-output : Copy any inflight subunit files] 2025-05-22 03:13:20.893371 | 2025-05-22 03:13:20.893805 | TASK [fetch-subunit-output : Create a temporary file to store the subunit stream] 2025-05-22 03:13:20.919957 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:20.926161 | 2025-05-22 03:13:20.926285 | LOOP [fetch-subunit-output : Generate subunit file] 2025-05-22 03:13:20.955958 | 2025-05-22 03:13:20.956156 | TASK [fetch-subunit-output : Copy the combined subunit file to the zuul work directory] 2025-05-22 03:13:20.979896 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:20.986771 | 2025-05-22 03:13:20.986933 | TASK [fetch-subunit-output : Remove the temporary file] 2025-05-22 03:13:21.010713 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:21.018780 | 2025-05-22 03:13:21.018965 | TASK [fetch-subunit-output : Process and fetch subunit results] 2025-05-22 03:13:21.043682 | debian-bookworm | skipping: Conditional result was False 2025-05-22 03:13:21.057641 | 2025-05-22 03:13:21.057783 | PLAY RECAP 2025-05-22 03:13:21.057874 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 8 rescued: 0 ignored: 0 2025-05-22 03:13:21.057922 | 2025-05-22 03:13:21.200472 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2025-05-22 03:13:21.203439 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2025-05-22 03:13:21.976278 | 2025-05-22 03:13:21.976442 | PLAY [Base post] 2025-05-22 03:13:22.000629 | 2025-05-22 03:13:22.000847 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2025-05-22 03:13:22.582670 | debian-bookworm | changed 2025-05-22 03:13:22.594453 | 2025-05-22 03:13:22.594572 | PLAY RECAP 2025-05-22 03:13:22.594677 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-05-22 03:13:22.594748 | 2025-05-22 03:13:22.736391 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2025-05-22 03:13:22.737518 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2025-05-22 03:13:23.587232 | 2025-05-22 03:13:23.587411 | PLAY [Base post-logs] 2025-05-22 03:13:23.598356 | 2025-05-22 03:13:23.598494 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2025-05-22 03:13:24.099476 | localhost | changed 2025-05-22 03:13:24.110459 | 2025-05-22 03:13:24.110678 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2025-05-22 03:13:24.136374 | localhost | ok 2025-05-22 03:13:24.139464 | 2025-05-22 03:13:24.139558 | TASK [Set zuul-log-path fact] 2025-05-22 03:13:24.154351 | localhost | ok 2025-05-22 03:13:24.162555 | 2025-05-22 03:13:24.162715 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-05-22 03:13:24.187765 | localhost | ok 2025-05-22 03:13:24.191393 | 2025-05-22 03:13:24.191498 | TASK [upload-logs : Create log directories] 2025-05-22 03:13:24.695313 | localhost | changed 2025-05-22 03:13:24.698279 | 2025-05-22 03:13:24.698383 | TASK [upload-logs : Ensure logs are readable before uploading] 2025-05-22 03:13:25.252523 | localhost -> localhost | ok: Runtime: 0:00:00.004480 2025-05-22 03:13:25.256870 | 2025-05-22 03:13:25.256988 | TASK [upload-logs : Upload logs to log server] 2025-05-22 03:13:25.855264 | localhost | Output suppressed because no_log was given 2025-05-22 03:13:25.857131 | 2025-05-22 03:13:25.857235 | LOOP [upload-logs : Compress console log and json output] 2025-05-22 03:13:25.905505 | localhost | skipping: Conditional result was False 2025-05-22 03:13:25.912443 | localhost | skipping: Conditional result was False 2025-05-22 03:13:25.929097 | 2025-05-22 03:13:25.929275 | LOOP [upload-logs : Upload compressed console log and json output] 2025-05-22 03:13:26.078380 | localhost | skipping: Conditional result was False 2025-05-22 03:13:26.078771 | 2025-05-22 03:13:26.092197 | localhost | skipping: Conditional result was False 2025-05-22 03:13:26.104139 | 2025-05-22 03:13:26.104269 | LOOP [upload-logs : Upload console log and json output]