2026-03-03 03:05:17.742694 | Job console starting 2026-03-03 03:05:17.771455 | Updating git repos 2026-03-03 03:05:17.823223 | Cloning repos into workspace 2026-03-03 03:05:17.912476 | Restoring repo states 2026-03-03 03:05:17.954925 | Merging changes 2026-03-03 03:05:17.954946 | Checking out repos 2026-03-03 03:05:18.030650 | Preparing playbooks 2026-03-03 03:05:19.144444 | Running Ansible setup 2026-03-03 03:05:24.750339 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-03-03 03:05:25.656959 | 2026-03-03 03:05:25.657089 | PLAY [Base pre] 2026-03-03 03:05:25.686073 | 2026-03-03 03:05:25.686216 | TASK [Setup log path fact] 2026-03-03 03:05:25.721741 | debian-bookworm | ok 2026-03-03 03:05:25.746697 | 2026-03-03 03:05:25.746827 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-03-03 03:05:25.800432 | debian-bookworm | ok 2026-03-03 03:05:25.814485 | 2026-03-03 03:05:25.814591 | TASK [emit-job-header : Print job information] 2026-03-03 03:05:25.874340 | # Job Information 2026-03-03 03:05:25.874558 | Ansible Version: 2.16.14 2026-03-03 03:05:25.874596 | Job: cfg-generics-tox-check 2026-03-03 03:05:25.874635 | Pipeline: periodic-daily 2026-03-03 03:05:25.874662 | Executor: 521e9411259a 2026-03-03 03:05:25.874683 | Triggered by: https://github.com/osism/generics 2026-03-03 03:05:25.874705 | Event ID: c1c4a379d042429fbe6ddbd1d12b4fff 2026-03-03 03:05:25.883626 | 2026-03-03 03:05:25.883730 | LOOP [emit-job-header : Print node information] 2026-03-03 03:05:26.111513 | debian-bookworm | ok: 2026-03-03 03:05:26.111801 | debian-bookworm | # Node Information 2026-03-03 03:05:26.111949 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-03-03 03:05:26.112010 | debian-bookworm | Hostname: debian 2026-03-03 03:05:26.112036 | debian-bookworm | Username: zuul 2026-03-03 03:05:26.112057 | debian-bookworm | Distro: Debian 12.13 2026-03-03 03:05:26.112119 | debian-bookworm | Provider: regiocloud-a 2026-03-03 03:05:26.112201 | debian-bookworm | Region: 2026-03-03 03:05:26.112224 | debian-bookworm | Label: debian-bookworm 2026-03-03 03:05:26.112256 | debian-bookworm | Product Name: OpenStack Nova 2026-03-03 03:05:26.112277 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe1f:104 2026-03-03 03:05:26.134519 | 2026-03-03 03:05:26.134637 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-03-03 03:05:26.811488 | debian-bookworm -> localhost | changed 2026-03-03 03:05:26.822624 | 2026-03-03 03:05:26.822769 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-03-03 03:05:28.643342 | debian-bookworm -> localhost | changed 2026-03-03 03:05:28.654818 | 2026-03-03 03:05:28.654982 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-03-03 03:05:29.219645 | debian-bookworm -> localhost | ok 2026-03-03 03:05:29.226191 | 2026-03-03 03:05:29.226330 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-03-03 03:05:29.272402 | debian-bookworm | ok 2026-03-03 03:05:29.294965 | debian-bookworm | included: /var/lib/zuul/builds/6137ad87640e4c0d9ba7d3fc7ea68076/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-03-03 03:05:29.302345 | 2026-03-03 03:05:29.302460 | TASK [add-build-sshkey : Create Temp SSH key] 2026-03-03 03:05:31.527501 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-03-03 03:05:31.527761 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/6137ad87640e4c0d9ba7d3fc7ea68076/work/6137ad87640e4c0d9ba7d3fc7ea68076_id_rsa 2026-03-03 03:05:31.527802 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/6137ad87640e4c0d9ba7d3fc7ea68076/work/6137ad87640e4c0d9ba7d3fc7ea68076_id_rsa.pub 2026-03-03 03:05:31.527828 | debian-bookworm -> localhost | The key fingerprint is: 2026-03-03 03:05:31.527852 | debian-bookworm -> localhost | SHA256:SQPxYxnoJ11qW8rDw4k8tattitXNBb2sUEdRWDWWjUw zuul-build-sshkey 2026-03-03 03:05:31.527874 | debian-bookworm -> localhost | The key's randomart image is: 2026-03-03 03:05:31.527908 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-03-03 03:05:31.527929 | debian-bookworm -> localhost | | oo. oBE=+| 2026-03-03 03:05:31.527951 | debian-bookworm -> localhost | | .o o.o. +.o| 2026-03-03 03:05:31.527970 | debian-bookworm -> localhost | | . .Boo o | 2026-03-03 03:05:31.527989 | debian-bookworm -> localhost | | oo*=.+ . | 2026-03-03 03:05:31.528009 | debian-bookworm -> localhost | | . XS* + | 2026-03-03 03:05:31.528035 | debian-bookworm -> localhost | | +.@+ o | 2026-03-03 03:05:31.528055 | debian-bookworm -> localhost | | ...++ | 2026-03-03 03:05:31.528074 | debian-bookworm -> localhost | | o .o | 2026-03-03 03:05:31.528094 | debian-bookworm -> localhost | | . o+. | 2026-03-03 03:05:31.528113 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-03-03 03:05:31.528215 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.403949 2026-03-03 03:05:31.534994 | 2026-03-03 03:05:31.535117 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-03-03 03:05:31.586048 | debian-bookworm | ok 2026-03-03 03:05:31.596057 | debian-bookworm | included: /var/lib/zuul/builds/6137ad87640e4c0d9ba7d3fc7ea68076/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-03-03 03:05:31.622211 | 2026-03-03 03:05:31.622349 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-03-03 03:05:31.656670 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:05:31.663902 | 2026-03-03 03:05:31.664043 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-03-03 03:05:32.477585 | debian-bookworm | changed 2026-03-03 03:05:32.483953 | 2026-03-03 03:05:32.484078 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-03-03 03:05:32.731368 | debian-bookworm | ok 2026-03-03 03:05:32.737024 | 2026-03-03 03:05:32.737151 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-03-03 03:05:33.432931 | debian-bookworm | changed 2026-03-03 03:05:33.444423 | 2026-03-03 03:05:33.444522 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-03-03 03:05:34.113518 | debian-bookworm | changed 2026-03-03 03:05:34.121997 | 2026-03-03 03:05:34.122099 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-03-03 03:05:34.156388 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:05:34.162523 | 2026-03-03 03:05:34.162611 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-03-03 03:05:34.625130 | debian-bookworm -> localhost | changed 2026-03-03 03:05:34.634160 | 2026-03-03 03:05:34.634250 | TASK [add-build-sshkey : Add back temp key] 2026-03-03 03:05:35.157609 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/6137ad87640e4c0d9ba7d3fc7ea68076/work/6137ad87640e4c0d9ba7d3fc7ea68076_id_rsa (zuul-build-sshkey) 2026-03-03 03:05:35.157830 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.016233 2026-03-03 03:05:35.166008 | 2026-03-03 03:05:35.166090 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-03-03 03:05:35.621495 | debian-bookworm | ok 2026-03-03 03:05:35.627590 | 2026-03-03 03:05:35.627688 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-03-03 03:05:35.681211 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:05:35.693728 | 2026-03-03 03:05:35.693829 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-03-03 03:05:36.098311 | debian-bookworm | ok 2026-03-03 03:05:36.129549 | 2026-03-03 03:05:36.129644 | TASK [validate-host : Define zuul_info_dir fact] 2026-03-03 03:05:36.156552 | debian-bookworm | ok 2026-03-03 03:05:36.162115 | 2026-03-03 03:05:36.162247 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-03-03 03:05:36.540838 | debian-bookworm -> localhost | ok 2026-03-03 03:05:36.559524 | 2026-03-03 03:05:36.560614 | TASK [validate-host : Collect information about the host] 2026-03-03 03:05:37.843787 | debian-bookworm | ok 2026-03-03 03:05:37.853857 | 2026-03-03 03:05:37.853952 | TASK [validate-host : Sanitize hostname] 2026-03-03 03:05:37.942753 | debian-bookworm | ok 2026-03-03 03:05:37.974540 | 2026-03-03 03:05:37.974649 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-03-03 03:05:38.543157 | debian-bookworm -> localhost | changed 2026-03-03 03:05:38.548509 | 2026-03-03 03:05:38.548602 | TASK [validate-host : Collect information about zuul worker] 2026-03-03 03:05:38.972309 | debian-bookworm | ok 2026-03-03 03:05:38.976930 | 2026-03-03 03:05:38.977026 | TASK [validate-host : Write out all zuul information for each host] 2026-03-03 03:05:39.536376 | debian-bookworm -> localhost | changed 2026-03-03 03:05:39.545432 | 2026-03-03 03:05:39.545519 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-03-03 03:05:39.814340 | debian-bookworm | ok 2026-03-03 03:05:39.819521 | 2026-03-03 03:05:39.819609 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-03-03 03:05:40.753890 | debian-bookworm | changed: 2026-03-03 03:05:40.754103 | debian-bookworm | cd+++++++++ src/ 2026-03-03 03:05:40.754157 | debian-bookworm | cd+++++++++ src/github.com/ 2026-03-03 03:05:40.754181 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-03-03 03:05:40.754202 | debian-bookworm | cd+++++++++ src/github.com/osism/generics/ 2026-03-03 03:05:40.754222 | debian-bookworm | =7.0.1 2026-03-03 03:06:02.823814 | debian-bookworm | Downloading cachetools-7.0.2-py3-none-any.whl (13 kB) 2026-03-03 03:06:02.884456 | debian-bookworm | Collecting colorama>=0.4.6 2026-03-03 03:06:02.896675 | debian-bookworm | Downloading colorama-0.4.6-py2.py3-none-any.whl (25 kB) 2026-03-03 03:06:02.958566 | debian-bookworm | Collecting filelock>=3.24.3 2026-03-03 03:06:02.969811 | debian-bookworm | Downloading filelock-3.25.0-py3-none-any.whl (26 kB) 2026-03-03 03:06:03.033637 | debian-bookworm | Collecting packaging>=26 2026-03-03 03:06:03.044608 | debian-bookworm | Downloading packaging-26.0-py3-none-any.whl (74 kB) 2026-03-03 03:06:03.053292 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 74.4/74.4 kB 10.4 MB/s eta 0:00:00 2026-03-03 03:06:03.104299 | debian-bookworm | Collecting platformdirs>=4.9.2 2026-03-03 03:06:03.115572 | debian-bookworm | Downloading platformdirs-4.9.2-py3-none-any.whl (21 kB) 2026-03-03 03:06:03.172966 | debian-bookworm | Collecting pluggy>=1.6 2026-03-03 03:06:03.183975 | debian-bookworm | Downloading pluggy-1.6.0-py3-none-any.whl (20 kB) 2026-03-03 03:06:03.232257 | debian-bookworm | Collecting pyproject-api>=1.10 2026-03-03 03:06:03.244066 | debian-bookworm | Downloading pyproject_api-1.10.0-py3-none-any.whl (13 kB) 2026-03-03 03:06:03.378697 | debian-bookworm | Collecting virtualenv>=20.39 2026-03-03 03:06:03.389419 | debian-bookworm | Downloading virtualenv-21.1.0-py3-none-any.whl (5.8 MB) 2026-03-03 03:06:03.666571 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 5.8/5.8 MB 21.4 MB/s eta 0:00:00 2026-03-03 03:06:03.751005 | debian-bookworm | Collecting distlib<1,>=0.3.7 2026-03-03 03:06:03.761999 | debian-bookworm | Downloading distlib-0.4.0-py2.py3-none-any.whl (469 kB) 2026-03-03 03:06:03.794430 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 469.0/469.0 kB 17.2 MB/s eta 0:00:00 2026-03-03 03:06:03.849783 | debian-bookworm | Collecting python-discovery>=1 2026-03-03 03:06:03.862402 | debian-bookworm | Downloading python_discovery-1.1.0-py3-none-any.whl (30 kB) 2026-03-03 03:06:03.993603 | debian-bookworm | Installing collected packages: distlib, pluggy, platformdirs, packaging, filelock, colorama, cachetools, python-discovery, pyproject-api, virtualenv, tox 2026-03-03 03:06:04.666136 | debian-bookworm | Successfully installed cachetools-7.0.2 colorama-0.4.6 distlib-0.4.0 filelock-3.25.0 packaging-26.0 platformdirs-4.9.2 pluggy-1.6.0 pyproject-api-1.10.0 python-discovery-1.1.0 tox-4.47.0 virtualenv-21.1.0 2026-03-03 03:06:05.208907 | debian-bookworm | ok: Runtime: 0:00:02.786176 2026-03-03 03:06:05.215579 | 2026-03-03 03:06:05.215731 | TASK [ensure-tox : Export installed tox_executable path] 2026-03-03 03:06:05.277050 | debian-bookworm | ok 2026-03-03 03:06:05.282189 | 2026-03-03 03:06:05.282316 | TASK [ensure-tox : Output tox version] 2026-03-03 03:06:05.981784 | debian-bookworm | ROOT: No loadable tox.ini or setup.cfg or pyproject.toml or tox.toml found, assuming empty tox.ini at /home/zuul 2026-03-03 03:06:06.000841 | debian-bookworm | 4.47.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2026-03-03 03:06:06.360908 | debian-bookworm | ok: Runtime: 0:00:00.315653 2026-03-03 03:06:06.367243 | 2026-03-03 03:06:06.367363 | TASK [ensure-tox : Make global symlink] 2026-03-03 03:06:06.412043 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:06.419626 | 2026-03-03 03:06:06.419739 | PLAY RECAP 2026-03-03 03:06:06.419796 | debian-bookworm | ok: 13 changed: 9 unreachable: 0 failed: 0 skipped: 14 rescued: 0 ignored: 0 2026-03-03 03:06:06.419820 | 2026-03-03 03:06:06.596613 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/pre.yaml@master] 2026-03-03 03:06:06.597728 | RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2026-03-03 03:06:07.771633 | 2026-03-03 03:06:07.771810 | PLAY [all] 2026-03-03 03:06:07.814472 | 2026-03-03 03:06:07.814647 | TASK [revoke-sudo : Check if zuul is sudoer] 2026-03-03 03:06:08.760536 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2026-03-03 03:06:08.886016 | debian-bookworm | ok: Runtime: 0:00:00.031160 2026-03-03 03:06:08.892419 | 2026-03-03 03:06:08.892572 | TASK [revoke-sudo : Remove sudo access for zuul user.] 2026-03-03 03:06:09.428088 | debian-bookworm | ok: Runtime: 0:00:00.007927 2026-03-03 03:06:09.434346 | 2026-03-03 03:06:09.434472 | TASK [revoke-sudo : Prove that general sudo access is actually revoked.] 2026-03-03 03:06:09.777323 | debian-bookworm | sudo: unable to resolve host debian: Name or service not known 2026-03-03 03:06:09.779567 | debian-bookworm | sudo: a password is required 2026-03-03 03:06:09.994981 | debian-bookworm | ok: Runtime: 0:00:00.023779 2026-03-03 03:06:10.004774 | 2026-03-03 03:06:10.004875 | TASK [tox : Check to see if the constraints file exists] 2026-03-03 03:06:10.038746 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:10.047884 | 2026-03-03 03:06:10.048015 | TASK [tox : Fail if constraints file is missing] 2026-03-03 03:06:10.107335 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:10.117197 | 2026-03-03 03:06:10.117345 | TASK [tox : Record file location] 2026-03-03 03:06:10.163322 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:10.169106 | 2026-03-03 03:06:10.169243 | TASK [tox : Install tox siblings] 2026-03-03 03:06:10.225865 | debian-bookworm | ok 2026-03-03 03:06:10.250909 | debian-bookworm | included: /var/lib/zuul/builds/6137ad87640e4c0d9ba7d3fc7ea68076/untrusted/project_0/github.com/osism/openinfra-zuul-jobs/roles/tox/tasks/siblings.yaml 2026-03-03 03:06:10.258772 | 2026-03-03 03:06:10.258932 | TASK [tox : Run tox without tests] 2026-03-03 03:06:10.801627 | debian-bookworm | ROOT: 187 D setup logging to DEBUG on pid 1418 [tox/report.py:229] 2026-03-03 03:06:10.830854 | debian-bookworm | check: 216 D created app data folder /home/zuul/.cache/virtualenv [virtualenv/app_data/__init__.py:65] 2026-03-03 03:06:10.833333 | debian-bookworm | check: 219 I find interpreter for spec PythonSpec(major=3, free_threaded=False) [python_discovery/_discovery.py:62] 2026-03-03 03:06:10.838459 | debian-bookworm | check: 224 D get interpreter info via cmd: /usr/bin/python3.11 /home/zuul/.local/tox/lib/python3.11/site-packages/python_discovery/_py_info.py 96767c12236873595fb50332f4591666 96e4f74e904bacbcf61ccc9a6b75cfd7 [python_discovery/_cached_py_info.py:197] 2026-03-03 03:06:10.916791 | debian-bookworm | check: 302 D wrote python info of /usr/bin/python3.11 at /home/zuul/.cache/virtualenv/py_info/4/ca3ed784184f1b3bb7c3539bfb45e71710cd27667424f92c2d5bb4df9c107c23.json [virtualenv/app_data/via_disk_folder.py:159] 2026-03-03 03:06:10.918329 | debian-bookworm | check: 304 D filesystem is case-sensitive [python_discovery/_compat.py:18] 2026-03-03 03:06:10.919083 | debian-bookworm | check: 304 I proposed PythonInfo(spec=CPython3.11.2.final.0-64-x86_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) [python_discovery/_discovery.py:71] 2026-03-03 03:06:10.919407 | debian-bookworm | check: 305 D accepted PythonInfo(spec=CPython3.11.2.final.0-64-x86_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) [python_discovery/_discovery.py:75] 2026-03-03 03:06:10.922437 | debian-bookworm | check: 308 D symlink on filesystem does work [virtualenv/info.py:51] 2026-03-03 03:06:10.922742 | debian-bookworm | check: 308 D filesystem is case-sensitive [virtualenv/info.py:28] 2026-03-03 03:06:10.959512 | debian-bookworm | check: 345 I create virtual environment via CPython3Posix(dest=/home/zuul/src/github.com/osism/generics/.tox/check, clear=False, no_vcs_ignore=False, global=False) [virtualenv/run/session.py:77] 2026-03-03 03:06:10.959783 | debian-bookworm | check: 345 D create folder /home/zuul/src/github.com/osism/generics/.tox/check/bin [virtualenv/util/path/_sync.py:18] 2026-03-03 03:06:10.959948 | debian-bookworm | check: 345 D create folder /home/zuul/src/github.com/osism/generics/.tox/check/include [virtualenv/util/path/_sync.py:18] 2026-03-03 03:06:10.960044 | debian-bookworm | check: 345 D create folder /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages [virtualenv/util/path/_sync.py:18] 2026-03-03 03:06:10.960243 | debian-bookworm | check: 346 D write /home/zuul/src/github.com/osism/generics/.tox/check/pyvenv.cfg [virtualenv/create/pyenv_cfg.py:41] 2026-03-03 03:06:10.960329 | debian-bookworm | check: 346 D home = /usr/bin [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960384 | debian-bookworm | check: 346 D implementation = CPython [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960434 | debian-bookworm | check: 346 D version_info = 3.11.2.final.0 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960491 | debian-bookworm | check: 346 D version = 3.11.2 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960539 | debian-bookworm | check: 346 D executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960589 | debian-bookworm | check: 346 D command = /home/zuul/.local/tox/bin/python3 -m virtualenv /home/zuul/src/github.com/osism/generics/.tox/check [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960636 | debian-bookworm | check: 346 D virtualenv = 21.1.0 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960684 | debian-bookworm | check: 346 D include-system-site-packages = false [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960731 | debian-bookworm | check: 346 D base-prefix = /usr [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960775 | debian-bookworm | check: 346 D base-exec-prefix = /usr [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.960821 | debian-bookworm | check: 346 D base-executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:10.961184 | debian-bookworm | check: 347 D symlink /usr/bin/python3.11 to /home/zuul/src/github.com/osism/generics/.tox/check/bin/python [virtualenv/util/path/_sync.py:38] 2026-03-03 03:06:10.961527 | debian-bookworm | check: 347 D create virtualenv import hook file /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/_virtualenv.pth [virtualenv/create/via_global_ref/api.py:118] 2026-03-03 03:06:10.961668 | debian-bookworm | check: 347 D create /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/_virtualenv.py [virtualenv/create/via_global_ref/api.py:121] 2026-03-03 03:06:10.962110 | debian-bookworm | check: 348 D ============================== target debug ============================== [virtualenv/run/session.py:79] 2026-03-03 03:06:10.962360 | debian-bookworm | check: 348 D debug via /home/zuul/src/github.com/osism/generics/.tox/check/bin/python /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/create/debug.py [virtualenv/create/creator.py:263] 2026-03-03 03:06:11.013810 | debian-bookworm | check: 348 D { 2026-03-03 03:06:11.013851 | debian-bookworm | "sys": { 2026-03-03 03:06:11.013858 | debian-bookworm | "executable": "/home/zuul/src/github.com/osism/generics/.tox/check/bin/python", 2026-03-03 03:06:11.013864 | debian-bookworm | "_base_executable": "/usr/bin/python3.11", 2026-03-03 03:06:11.013907 | debian-bookworm | "prefix": "/home/zuul/src/github.com/osism/generics/.tox/check", 2026-03-03 03:06:11.013913 | debian-bookworm | "base_prefix": "/usr", 2026-03-03 03:06:11.013921 | debian-bookworm | "real_prefix": null, 2026-03-03 03:06:11.013925 | debian-bookworm | "exec_prefix": "/home/zuul/src/github.com/osism/generics/.tox/check", 2026-03-03 03:06:11.013930 | debian-bookworm | "base_exec_prefix": "/usr", 2026-03-03 03:06:11.013934 | debian-bookworm | "path": [ 2026-03-03 03:06:11.013938 | debian-bookworm | "/usr/lib/python311.zip", 2026-03-03 03:06:11.013943 | debian-bookworm | "/usr/lib/python3.11", 2026-03-03 03:06:11.013947 | debian-bookworm | "/usr/lib/python3.11/lib-dynload", 2026-03-03 03:06:11.013951 | debian-bookworm | "/home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages" 2026-03-03 03:06:11.013955 | debian-bookworm | ], 2026-03-03 03:06:11.013959 | debian-bookworm | "meta_path": [ 2026-03-03 03:06:11.013963 | debian-bookworm | "", 2026-03-03 03:06:11.013967 | debian-bookworm | "", 2026-03-03 03:06:11.013971 | debian-bookworm | "", 2026-03-03 03:06:11.013980 | debian-bookworm | "" 2026-03-03 03:06:11.013984 | debian-bookworm | ], 2026-03-03 03:06:11.013988 | debian-bookworm | "fs_encoding": "utf-8", 2026-03-03 03:06:11.013992 | debian-bookworm | "io_encoding": "utf-8" 2026-03-03 03:06:11.013996 | debian-bookworm | }, 2026-03-03 03:06:11.014000 | debian-bookworm | "version": "3.11.2 (main, Apr 28 2025, 14:11:48) [GCC 12.2.0]", 2026-03-03 03:06:11.014004 | debian-bookworm | "makefile_filename": "/usr/lib/python3.11/config-3.11-x86_64-linux-gnu/Makefile", 2026-03-03 03:06:11.014008 | debian-bookworm | "os": "", 2026-03-03 03:06:11.014012 | debian-bookworm | "site": "", 2026-03-03 03:06:11.014016 | debian-bookworm | "datetime": "", 2026-03-03 03:06:11.014020 | debian-bookworm | "math": "", 2026-03-03 03:06:11.014024 | debian-bookworm | "json": "" 2026-03-03 03:06:11.014028 | debian-bookworm | } [virtualenv/run/session.py:80] 2026-03-03 03:06:11.014193 | debian-bookworm | check: 399 I add seed packages via FromAppData(download=False, pip=bundle, setuptools=bundle, via=copy, app_data_dir=/home/zuul/.cache/virtualenv) [virtualenv/run/session.py:84] 2026-03-03 03:06:11.016900 | debian-bookworm | check: 402 D install pip from wheel /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/seed/wheels/embed/pip-26.0.1-py3-none-any.whl via CopyPipInstall [virtualenv/seed/embed/via_app_data/via_app_data.py:65] 2026-03-03 03:06:11.019954 | debian-bookworm | check: 403 D build install image for pip-26.0.1-py3-none-any.whl to /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-26.0.1-py3-none-any [virtualenv/seed/embed/via_app_data/pip_install/base.py:53] 2026-03-03 03:06:11.025580 | debian-bookworm | check: 411 D install setuptools from wheel /home/zuul/.local/tox/lib/python3.11/site-packages/virtualenv/seed/wheels/embed/setuptools-82.0.0-py3-none-any.whl via CopyPipInstall [virtualenv/seed/embed/via_app_data/via_app_data.py:65] 2026-03-03 03:06:11.028135 | debian-bookworm | check: 413 D build install image for setuptools-82.0.0-py3-none-any.whl to /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-82.0.0-py3-none-any [virtualenv/seed/embed/via_app_data/pip_install/base.py:53] 2026-03-03 03:06:11.191831 | debian-bookworm | check: 577 D copy directory /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-82.0.0-py3-none-any/_distutils_hack to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/_distutils_hack [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.193984 | debian-bookworm | check: 579 D copy directory /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-82.0.0-py3-none-any/setuptools-82.0.0.dist-info to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/setuptools-82.0.0.dist-info [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.197445 | debian-bookworm | check: 583 D copy /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-82.0.0-py3-none-any/distutils-precedence.pth to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/distutils-precedence.pth [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.197735 | debian-bookworm | check: 583 D copy directory /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-82.0.0-py3-none-any/setuptools to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/setuptools [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.254863 | debian-bookworm | check: 640 D copy /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-26.0.1-py3-none-any/pip-26.0.1.virtualenv to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/pip-26.0.1.virtualenv [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.255408 | debian-bookworm | check: 641 D copy directory /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-26.0.1-py3-none-any/pip to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/pip [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.385485 | debian-bookworm | check: 771 D copy /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/setuptools-82.0.0-py3-none-any/setuptools-82.0.0.virtualenv to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/setuptools-82.0.0.virtualenv [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.386029 | debian-bookworm | check: 771 D generated console scripts [virtualenv/seed/embed/via_app_data/pip_install/base.py:49] 2026-03-03 03:06:11.387787 | debian-bookworm | check: 773 D copy directory /home/zuul/.cache/virtualenv/wheel/3.11/image/1/CopyPipInstall/pip-26.0.1-py3-none-any/pip-26.0.1.dist-info to /home/zuul/src/github.com/osism/generics/.tox/check/lib/python3.11/site-packages/pip-26.0.1.dist-info [virtualenv/util/path/_sync.py:46] 2026-03-03 03:06:11.394165 | debian-bookworm | check: 780 D generated console scripts pip3.11 pip3 pip pip-3.11 [virtualenv/seed/embed/via_app_data/pip_install/base.py:49] 2026-03-03 03:06:11.394512 | debian-bookworm | check: 780 I add activators for Bash, CShell, Fish, Nushell, PowerShell, Python [virtualenv/run/session.py:90] 2026-03-03 03:06:11.399220 | debian-bookworm | check: 785 D write /home/zuul/src/github.com/osism/generics/.tox/check/pyvenv.cfg [virtualenv/create/pyenv_cfg.py:41] 2026-03-03 03:06:11.399347 | debian-bookworm | check: 785 D home = /usr/bin [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399393 | debian-bookworm | check: 785 D implementation = CPython [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399400 | debian-bookworm | check: 785 D version_info = 3.11.2.final.0 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399406 | debian-bookworm | check: 785 D version = 3.11.2 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399468 | debian-bookworm | check: 785 D executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399503 | debian-bookworm | check: 785 D command = /home/zuul/.local/tox/bin/python3 -m virtualenv /home/zuul/src/github.com/osism/generics/.tox/check [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399553 | debian-bookworm | check: 785 D virtualenv = 21.1.0 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399596 | debian-bookworm | check: 785 D include-system-site-packages = false [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399647 | debian-bookworm | check: 785 D base-prefix = /usr [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399692 | debian-bookworm | check: 785 D base-exec-prefix = /usr [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.399736 | debian-bookworm | check: 785 D base-executable = /usr/bin/python3.11 [virtualenv/create/pyenv_cfg.py:51] 2026-03-03 03:06:11.404175 | debian-bookworm | check: 790 W install_deps> python -I -m pip install -r requirements.txt [tox/tox_env/api.py:499] 2026-03-03 03:06:12.438971 | debian-bookworm | Collecting Jinja2==3.1.6 (from -r requirements.txt (line 1)) 2026-03-03 03:06:12.580586 | debian-bookworm | Downloading jinja2-3.1.6-py3-none-any.whl.metadata (2.9 kB) 2026-03-03 03:06:12.688784 | debian-bookworm | Collecting PyYAML==6.0.3 (from -r requirements.txt (line 2)) 2026-03-03 03:06:12.700766 | debian-bookworm | Downloading pyyaml-6.0.3-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.manylinux_2_28_x86_64.whl.metadata (2.4 kB) 2026-03-03 03:06:12.767258 | debian-bookworm | Collecting ansible==11.12.0 (from -r requirements.txt (line 3)) 2026-03-03 03:06:12.779494 | debian-bookworm | Downloading ansible-11.12.0-py3-none-any.whl.metadata (8.1 kB) 2026-03-03 03:06:12.820795 | debian-bookworm | Collecting packaging==26.0 (from -r requirements.txt (line 4)) 2026-03-03 03:06:12.832927 | debian-bookworm | Downloading packaging-26.0-py3-none-any.whl.metadata (3.3 kB) 2026-03-03 03:06:12.864889 | debian-bookworm | Collecting pwgen==0.8.2.post0 (from -r requirements.txt (line 5)) 2026-03-03 03:06:12.877641 | debian-bookworm | Downloading pwgen-0.8.2.post0.tar.gz (2.9 kB) 2026-03-03 03:06:12.891203 | debian-bookworm | Installing build dependencies: started 2026-03-03 03:06:14.121461 | debian-bookworm | Installing build dependencies: finished with status 'done' 2026-03-03 03:06:14.123208 | debian-bookworm | Getting requirements to build wheel: started 2026-03-03 03:06:14.542722 | debian-bookworm | Getting requirements to build wheel: finished with status 'done' 2026-03-03 03:06:14.545386 | debian-bookworm | Preparing metadata (pyproject.toml): started 2026-03-03 03:06:14.770536 | debian-bookworm | Preparing metadata (pyproject.toml): finished with status 'done' 2026-03-03 03:06:14.811006 | debian-bookworm | Collecting python-gilt==1.2.3 (from -r requirements.txt (line 6)) 2026-03-03 03:06:14.824403 | debian-bookworm | Downloading python_gilt-1.2.3-py2.py3-none-any.whl.metadata (1.4 kB) 2026-03-03 03:06:14.889529 | debian-bookworm | Collecting requests==2.32.5 (from -r requirements.txt (line 7)) 2026-03-03 03:06:14.901085 | debian-bookworm | Downloading requests-2.32.5-py3-none-any.whl.metadata (4.9 kB) 2026-03-03 03:06:14.936315 | debian-bookworm | Collecting tabulate==0.9.0 (from -r requirements.txt (line 8)) 2026-03-03 03:06:14.948358 | debian-bookworm | Downloading tabulate-0.9.0-py3-none-any.whl.metadata (34 kB) 2026-03-03 03:06:15.057422 | debian-bookworm | Collecting MarkupSafe>=2.0 (from Jinja2==3.1.6->-r requirements.txt (line 1)) 2026-03-03 03:06:15.069677 | debian-bookworm | Downloading markupsafe-3.0.3-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.manylinux_2_28_x86_64.whl.metadata (2.7 kB) 2026-03-03 03:06:15.139055 | debian-bookworm | Collecting ansible-core~=2.18.11 (from ansible==11.12.0->-r requirements.txt (line 3)) 2026-03-03 03:06:15.151276 | debian-bookworm | Downloading ansible_core-2.18.14-py3-none-any.whl.metadata (7.7 kB) 2026-03-03 03:06:15.241254 | debian-bookworm | Collecting click (from python-gilt==1.2.3->-r requirements.txt (line 6)) 2026-03-03 03:06:15.252888 | debian-bookworm | Downloading click-8.3.1-py3-none-any.whl.metadata (2.6 kB) 2026-03-03 03:06:15.301937 | debian-bookworm | Collecting colorama (from python-gilt==1.2.3->-r requirements.txt (line 6)) 2026-03-03 03:06:15.316207 | debian-bookworm | Downloading colorama-0.4.6-py2.py3-none-any.whl.metadata (17 kB) 2026-03-03 03:06:15.368068 | debian-bookworm | Collecting fasteners (from python-gilt==1.2.3->-r requirements.txt (line 6)) 2026-03-03 03:06:15.380814 | debian-bookworm | Downloading fasteners-0.20-py3-none-any.whl.metadata (4.8 kB) 2026-03-03 03:06:15.428112 | debian-bookworm | Collecting sh (from python-gilt==1.2.3->-r requirements.txt (line 6)) 2026-03-03 03:06:15.440204 | debian-bookworm | Downloading sh-2.2.2-py3-none-any.whl.metadata (3.7 kB) 2026-03-03 03:06:15.576544 | debian-bookworm | Collecting charset_normalizer<4,>=2 (from requests==2.32.5->-r requirements.txt (line 7)) 2026-03-03 03:06:15.587880 | debian-bookworm | Downloading charset_normalizer-3.4.4-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.manylinux_2_28_x86_64.whl.metadata (37 kB) 2026-03-03 03:06:15.661034 | debian-bookworm | Collecting idna<4,>=2.5 (from requests==2.32.5->-r requirements.txt (line 7)) 2026-03-03 03:06:15.674102 | debian-bookworm | Downloading idna-3.11-py3-none-any.whl.metadata (8.4 kB) 2026-03-03 03:06:15.758334 | debian-bookworm | Collecting urllib3<3,>=1.21.1 (from requests==2.32.5->-r requirements.txt (line 7)) 2026-03-03 03:06:15.769814 | debian-bookworm | Downloading urllib3-2.6.3-py3-none-any.whl.metadata (6.9 kB) 2026-03-03 03:06:15.823467 | debian-bookworm | Collecting certifi>=2017.4.17 (from requests==2.32.5->-r requirements.txt (line 7)) 2026-03-03 03:06:15.836079 | debian-bookworm | Downloading certifi-2026.2.25-py3-none-any.whl.metadata (2.5 kB) 2026-03-03 03:06:16.094703 | debian-bookworm | Collecting cryptography (from ansible-core~=2.18.11->ansible==11.12.0->-r requirements.txt (line 3)) 2026-03-03 03:06:16.106174 | debian-bookworm | Downloading cryptography-46.0.5-cp311-abi3-manylinux_2_34_x86_64.whl.metadata (5.7 kB) 2026-03-03 03:06:16.144250 | debian-bookworm | Collecting resolvelib<1.1.0,>=0.5.3 (from ansible-core~=2.18.11->ansible==11.12.0->-r requirements.txt (line 3)) 2026-03-03 03:06:16.155634 | debian-bookworm | Downloading resolvelib-1.0.1-py2.py3-none-any.whl.metadata (4.0 kB) 2026-03-03 03:06:16.351186 | debian-bookworm | Collecting cffi>=2.0.0 (from cryptography->ansible-core~=2.18.11->ansible==11.12.0->-r requirements.txt (line 3)) 2026-03-03 03:06:16.363305 | debian-bookworm | Downloading cffi-2.0.0-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.whl.metadata (2.6 kB) 2026-03-03 03:06:16.404463 | debian-bookworm | Collecting pycparser (from cffi>=2.0.0->cryptography->ansible-core~=2.18.11->ansible==11.12.0->-r requirements.txt (line 3)) 2026-03-03 03:06:16.416402 | debian-bookworm | Downloading pycparser-3.0-py3-none-any.whl.metadata (8.2 kB) 2026-03-03 03:06:16.443499 | debian-bookworm | Downloading jinja2-3.1.6-py3-none-any.whl (134 kB) 2026-03-03 03:06:16.476308 | debian-bookworm | Downloading pyyaml-6.0.3-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.manylinux_2_28_x86_64.whl (806 kB) 2026-03-03 03:06:16.570046 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 806.6/806.6 kB 7.9 MB/s 0:00:00 2026-03-03 03:06:16.584862 | debian-bookworm | Downloading ansible-11.12.0-py3-none-any.whl (57.4 MB) 2026-03-03 03:06:19.364377 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 57.4/57.4 MB 20.6 MB/s 0:00:02 2026-03-03 03:06:19.376966 | debian-bookworm | Downloading packaging-26.0-py3-none-any.whl (74 kB) 2026-03-03 03:06:19.450540 | debian-bookworm | Downloading python_gilt-1.2.3-py2.py3-none-any.whl (22 kB) 2026-03-03 03:06:19.473547 | debian-bookworm | Downloading requests-2.32.5-py3-none-any.whl (64 kB) 2026-03-03 03:06:19.495129 | debian-bookworm | Downloading tabulate-0.9.0-py3-none-any.whl (35 kB) 2026-03-03 03:06:19.516258 | debian-bookworm | Downloading ansible_core-2.18.14-py3-none-any.whl (2.2 MB) 2026-03-03 03:06:19.616337 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 2.2/2.2 MB 21.9 MB/s 0:00:00 2026-03-03 03:06:19.629707 | debian-bookworm | Downloading charset_normalizer-3.4.4-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.manylinux_2_28_x86_64.whl (151 kB) 2026-03-03 03:06:19.654985 | debian-bookworm | Downloading idna-3.11-py3-none-any.whl (71 kB) 2026-03-03 03:06:19.679465 | debian-bookworm | Downloading resolvelib-1.0.1-py2.py3-none-any.whl (17 kB) 2026-03-03 03:06:19.703023 | debian-bookworm | Downloading urllib3-2.6.3-py3-none-any.whl (131 kB) 2026-03-03 03:06:19.728012 | debian-bookworm | Downloading certifi-2026.2.25-py3-none-any.whl (153 kB) 2026-03-03 03:06:19.757937 | debian-bookworm | Downloading markupsafe-3.0.3-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.manylinux_2_28_x86_64.whl (22 kB) 2026-03-03 03:06:19.782122 | debian-bookworm | Downloading click-8.3.1-py3-none-any.whl (108 kB) 2026-03-03 03:06:19.806347 | debian-bookworm | Downloading colorama-0.4.6-py2.py3-none-any.whl (25 kB) 2026-03-03 03:06:19.829561 | debian-bookworm | Downloading cryptography-46.0.5-cp311-abi3-manylinux_2_34_x86_64.whl (4.5 MB) 2026-03-03 03:06:20.014017 | debian-bookworm | ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 4.5/4.5 MB 24.3 MB/s 0:00:00 2026-03-03 03:06:20.029222 | debian-bookworm | Downloading cffi-2.0.0-cp311-cp311-manylinux2014_x86_64.manylinux_2_17_x86_64.whl (215 kB) 2026-03-03 03:06:20.056922 | debian-bookworm | Downloading fasteners-0.20-py3-none-any.whl (18 kB) 2026-03-03 03:06:20.080362 | debian-bookworm | Downloading pycparser-3.0-py3-none-any.whl (48 kB) 2026-03-03 03:06:20.104794 | debian-bookworm | Downloading sh-2.2.2-py3-none-any.whl (38 kB) 2026-03-03 03:06:20.398905 | debian-bookworm | Building wheels for collected packages: pwgen 2026-03-03 03:06:20.400442 | debian-bookworm | Building wheel for pwgen (pyproject.toml): started 2026-03-03 03:06:20.687695 | debian-bookworm | Building wheel for pwgen (pyproject.toml): finished with status 'done' 2026-03-03 03:06:20.689707 | debian-bookworm | Created wheel for pwgen: filename=pwgen-0.8.2.post0-py3-none-any.whl size=3796 sha256=1e7afeb6eedca6178a2e5ee8277f71b4586af2e02949c6538622869f5e401e85 2026-03-03 03:06:20.690494 | debian-bookworm | Stored in directory: /home/zuul/.cache/pip/wheels/c3/81/ed/8e13725daf8a767fbde13d7583ce457f3fdf974023341fac95 2026-03-03 03:06:20.695369 | debian-bookworm | Successfully built pwgen 2026-03-03 03:06:20.935340 | debian-bookworm | Installing collected packages: resolvelib, pwgen, urllib3, tabulate, sh, PyYAML, pycparser, packaging, MarkupSafe, idna, fasteners, colorama, click, charset_normalizer, certifi, requests, python-gilt, Jinja2, cffi, cryptography, ansible-core, ansible 2026-03-03 03:06:47.031143 | debian-bookworm | 2026-03-03 03:06:47.032552 | debian-bookworm | Successfully installed Jinja2-3.1.6 MarkupSafe-3.0.3 PyYAML-6.0.3 ansible-11.12.0 ansible-core-2.18.14 certifi-2026.2.25 cffi-2.0.0 charset_normalizer-3.4.4 click-8.3.1 colorama-0.4.6 cryptography-46.0.5 fasteners-0.20 idna-3.11 packaging-26.0 pwgen-0.8.2.post0 pycparser-3.0 python-gilt-1.2.3 requests-2.32.5 resolvelib-1.0.1 sh-2.2.2 tabulate-0.9.0 urllib3-2.6.3 2026-03-03 03:06:47.143656 | debian-bookworm | check: 36529 I exit 0 (35.74 seconds) /home/zuul/src/github.com/osism/generics> python -I -m pip install -r requirements.txt pid=1431 [tox/execute/api.py:311] 2026-03-03 03:06:47.144682 | debian-bookworm | check: OK (36.32 seconds) 2026-03-03 03:06:47.144726 | debian-bookworm | congratulations :) (36.34 seconds) 2026-03-03 03:06:47.338517 | debian-bookworm | ok: Runtime: 0:00:36.601335 2026-03-03 03:06:47.346543 | 2026-03-03 03:06:47.346664 | TASK [tox : Create a tempfile to save tox showconfig] 2026-03-03 03:06:47.978159 | debian-bookworm | changed 2026-03-03 03:06:47.989338 | 2026-03-03 03:06:47.989488 | TASK [tox : Get tox envlist config] 2026-03-03 03:06:49.052637 | debian-bookworm | ok: Runtime: 0:00:00.289221 2026-03-03 03:06:49.058512 | 2026-03-03 03:06:49.058628 | TASK [tox : Install any sibling python packages] 2026-03-03 03:06:49.841613 | debian-bookworm | ok: No setup.cfg, no action needed 2026-03-03 03:06:49.847241 | 2026-03-03 03:06:49.847355 | TASK [tox : Remove tempfile] 2026-03-03 03:06:50.319026 | debian-bookworm | changed 2026-03-03 03:06:50.325178 | 2026-03-03 03:06:50.325307 | TASK [tox : Emit tox command] 2026-03-03 03:06:50.394752 | /home/zuul/.local/tox/bin/tox -echeck -vv --skip-missing-interpreters=false 2026-03-03 03:06:50.400294 | 2026-03-03 03:06:50.400420 | TASK [tox : Run tox] 2026-03-03 03:06:51.180446 | debian-bookworm | ROOT: 189 D setup logging to DEBUG on pid 1586 [tox/report.py:229] 2026-03-03 03:06:51.209162 | debian-bookworm | check: 218 D created app data folder /home/zuul/.cache/virtualenv [virtualenv/app_data/__init__.py:65] 2026-03-03 03:06:51.211635 | debian-bookworm | check: 220 I find interpreter for spec PythonSpec(major=3, free_threaded=False) [python_discovery/_discovery.py:62] 2026-03-03 03:06:51.215366 | debian-bookworm | check: 224 D got python info of /usr/bin/python3.11 from /home/zuul/.cache/virtualenv/py_info/4/ca3ed784184f1b3bb7c3539bfb45e71710cd27667424f92c2d5bb4df9c107c23.json [virtualenv/app_data/via_disk_folder.py:139] 2026-03-03 03:06:51.216314 | debian-bookworm | check: 225 D filesystem is case-sensitive [python_discovery/_compat.py:18] 2026-03-03 03:06:51.216448 | debian-bookworm | check: 225 I proposed PythonInfo(spec=CPython3.11.2.final.0-64-x86_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) [python_discovery/_discovery.py:71] 2026-03-03 03:06:51.216536 | debian-bookworm | check: 226 D accepted PythonInfo(spec=CPython3.11.2.final.0-64-x86_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) [python_discovery/_discovery.py:75] 2026-03-03 03:06:51.217990 | debian-bookworm | check: 227 D symlink on filesystem does work [virtualenv/info.py:51] 2026-03-03 03:06:51.218087 | debian-bookworm | check: 227 D filesystem is case-sensitive [virtualenv/info.py:28] 2026-03-03 03:06:51.249610 | debian-bookworm | check: 258 W commands[0]> python3 src/check-inventory-sorting.py [tox/tox_env/api.py:499] 2026-03-03 03:06:51.325662 | debian-bookworm | check: 334 I exit 0 (0.07 seconds) /home/zuul/src/github.com/osism/generics> python3 src/check-inventory-sorting.py pid=1593 [tox/execute/api.py:311] 2026-03-03 03:06:51.326735 | debian-bookworm | check: OK (0.12=setup[0.05]+cmd[0.07] seconds) 2026-03-03 03:06:51.326758 | debian-bookworm | congratulations :) (0.15 seconds) 2026-03-03 03:06:51.606132 | debian-bookworm | ok: Runtime: 0:00:00.427295 2026-03-03 03:06:51.612078 | 2026-03-03 03:06:51.612228 | TASK [tox : Look for output] 2026-03-03 03:06:52.097110 | debian-bookworm | ok 2026-03-03 03:06:52.118313 | 2026-03-03 03:06:52.118458 | TASK [tox : Return file comments to Zuul] 2026-03-03 03:06:52.173592 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:52.180675 | 2026-03-03 03:06:52.180779 | PLAY RECAP 2026-03-03 03:06:52.180834 | debian-bookworm | ok: 12 changed: 8 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 0 2026-03-03 03:06:52.180859 | 2026-03-03 03:06:52.327680 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/run.yaml@master] 2026-03-03 03:06:52.328775 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2026-03-03 03:06:53.136578 | 2026-03-03 03:06:53.136703 | PLAY [all] 2026-03-03 03:06:53.150209 | 2026-03-03 03:06:53.150325 | TASK [fetch-tox-output : Set tox log path for multiple nodes] 2026-03-03 03:06:53.203916 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:53.209467 | 2026-03-03 03:06:53.209586 | TASK [fetch-tox-output : Set tox log path for single node] 2026-03-03 03:06:53.277386 | debian-bookworm | ok 2026-03-03 03:06:53.283166 | 2026-03-03 03:06:53.283268 | TASK [fetch-tox-output : Ensure local tox dir] 2026-03-03 03:06:53.804457 | debian-bookworm -> localhost | changed 2026-03-03 03:06:53.825375 | 2026-03-03 03:06:53.825483 | TASK [fetch-tox-output : Ensure zuul-output tox dir] 2026-03-03 03:06:53.901218 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:53.906707 | 2026-03-03 03:06:53.906821 | TASK [fetch-tox-output : Set envlist fact] 2026-03-03 03:06:53.934719 | debian-bookworm | ok 2026-03-03 03:06:53.941836 | 2026-03-03 03:06:53.941932 | TASK [fetch-tox-output : Get tox version] 2026-03-03 03:06:54.578855 | debian-bookworm | ROOT: No loadable tox.ini or setup.cfg or pyproject.toml or tox.toml found, assuming empty tox.ini at /home/zuul 2026-03-03 03:06:54.597337 | debian-bookworm | 4.47.0 from /home/zuul/.local/tox/lib/python3.11/site-packages/tox/__init__.py 2026-03-03 03:06:54.984910 | debian-bookworm | ok: Runtime: 0:00:00.292593 2026-03-03 03:06:54.991534 | 2026-03-03 03:06:54.991626 | TASK [fetch-tox-output : Find all default environments] 2026-03-03 03:06:55.522310 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:55.528714 | 2026-03-03 03:06:55.528813 | TASK [fetch-tox-output : Set envlist fact] 2026-03-03 03:06:55.563054 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:55.579163 | 2026-03-03 03:06:55.579350 | TASK [fetch-tox-output : Find all default environments] 2026-03-03 03:06:56.119724 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:56.130710 | 2026-03-03 03:06:56.130888 | TASK [fetch-tox-output : Set envlist fact] 2026-03-03 03:06:56.167286 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:56.176343 | 2026-03-03 03:06:56.176465 | LOOP [fetch-tox-output : Copy tox logs] 2026-03-03 03:06:56.245133 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:56.269669 | 2026-03-03 03:06:56.269824 | LOOP [fetch-tox-output : Collect tox logs] 2026-03-03 03:06:57.025979 | debian-bookworm | changed: 2026-03-03 03:06:57.026181 | debian-bookworm | created directory /var/lib/zuul/builds/6137ad87640e4c0d9ba7d3fc7ea68076/work/logs/tox/check 2026-03-03 03:06:57.026219 | debian-bookworm | cd+++++++++ ./ 2026-03-03 03:06:57.026244 | debian-bookworm | >f+++++++++ 1-commands[0].log 2026-03-03 03:06:57.026272 | 2026-03-03 03:06:57.041978 | 2026-03-03 03:06:57.042063 | PLAY RECAP 2026-03-03 03:06:57.042124 | debian-bookworm | ok: 5 changed: 3 unreachable: 0 failed: 0 skipped: 7 rescued: 0 ignored: 0 2026-03-03 03:06:57.042150 | 2026-03-03 03:06:57.190272 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/tox/post.yaml@master] 2026-03-03 03:06:57.191179 | POST-RUN START: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2026-03-03 03:06:58.000896 | 2026-03-03 03:06:58.001034 | PLAY [all] 2026-03-03 03:06:58.015358 | 2026-03-03 03:06:58.015471 | TASK [fetch-subunit-output : Find stestr or testr executable] 2026-03-03 03:06:58.215803 | debian-bookworm | changed: non-zero return code 2026-03-03 03:06:58.221625 | 2026-03-03 03:06:58.221757 | TASK [fetch-subunit-output : Get the list of directories with subunit files] 2026-03-03 03:06:58.245785 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:58.251929 | 2026-03-03 03:06:58.252064 | LOOP [fetch-subunit-output : Find any inflight partial subunit files] 2026-03-03 03:06:58.301610 | 2026-03-03 03:06:58.301922 | LOOP [fetch-subunit-output : Copy any inflight subunit files] 2026-03-03 03:06:58.348036 | 2026-03-03 03:06:58.348252 | TASK [fetch-subunit-output : Create a temporary file to store the subunit stream] 2026-03-03 03:06:58.372365 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:58.379130 | 2026-03-03 03:06:58.379251 | LOOP [fetch-subunit-output : Generate subunit file] 2026-03-03 03:06:58.408458 | 2026-03-03 03:06:58.408664 | TASK [fetch-subunit-output : Copy the combined subunit file to the zuul work directory] 2026-03-03 03:06:58.432211 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:58.438194 | 2026-03-03 03:06:58.438309 | TASK [fetch-subunit-output : Remove the temporary file] 2026-03-03 03:06:58.452464 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:58.459637 | 2026-03-03 03:06:58.459780 | TASK [fetch-subunit-output : Process and fetch subunit results] 2026-03-03 03:06:58.485680 | debian-bookworm | skipping: Conditional result was False 2026-03-03 03:06:58.492326 | 2026-03-03 03:06:58.492421 | PLAY RECAP 2026-03-03 03:06:58.492472 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 8 rescued: 0 ignored: 0 2026-03-03 03:06:58.492499 | 2026-03-03 03:06:58.623533 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/osism/openinfra-zuul-jobs/playbooks/unittests/post.yaml@master] 2026-03-03 03:06:58.626066 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-03-03 03:06:59.389721 | 2026-03-03 03:06:59.389887 | PLAY [Base post] 2026-03-03 03:06:59.403712 | 2026-03-03 03:06:59.403852 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-03-03 03:07:00.006277 | debian-bookworm | changed 2026-03-03 03:07:00.012874 | 2026-03-03 03:07:00.013010 | PLAY RECAP 2026-03-03 03:07:00.013076 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-03-03 03:07:00.013174 | 2026-03-03 03:07:00.146994 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-03-03 03:07:00.148049 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-03-03 03:07:00.965604 | 2026-03-03 03:07:00.965782 | PLAY [Base post-logs] 2026-03-03 03:07:00.976881 | 2026-03-03 03:07:00.977032 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-03-03 03:07:01.491475 | localhost | changed 2026-03-03 03:07:01.501704 | 2026-03-03 03:07:01.501886 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-03-03 03:07:01.528060 | localhost | ok 2026-03-03 03:07:01.531317 | 2026-03-03 03:07:01.531427 | TASK [Set zuul-log-path fact] 2026-03-03 03:07:01.557147 | localhost | ok 2026-03-03 03:07:01.565535 | 2026-03-03 03:07:01.565673 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-03-03 03:07:01.591588 | localhost | ok 2026-03-03 03:07:01.594871 | 2026-03-03 03:07:01.594986 | TASK [upload-logs : Create log directories] 2026-03-03 03:07:02.219559 | localhost | changed 2026-03-03 03:07:02.225075 | 2026-03-03 03:07:02.225232 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-03-03 03:07:02.840973 | localhost -> localhost | ok: Runtime: 0:00:00.008753 2026-03-03 03:07:02.845288 | 2026-03-03 03:07:02.845423 | TASK [upload-logs : Upload logs to log server] 2026-03-03 03:07:03.542903 | localhost | Output suppressed because no_log was given 2026-03-03 03:07:03.546435 | 2026-03-03 03:07:03.546627 | LOOP [upload-logs : Compress console log and json output] 2026-03-03 03:07:03.596766 | localhost | skipping: Conditional result was False 2026-03-03 03:07:03.603662 | localhost | skipping: Conditional result was False 2026-03-03 03:07:03.609851 | 2026-03-03 03:07:03.610031 | LOOP [upload-logs : Upload compressed console log and json output] 2026-03-03 03:07:03.659809 | localhost | skipping: Conditional result was False 2026-03-03 03:07:03.660512 | 2026-03-03 03:07:03.664030 | localhost | skipping: Conditional result was False 2026-03-03 03:07:03.669935 | 2026-03-03 03:07:03.670137 | LOOP [upload-logs : Upload console log and json output]