2026-08-13 20:07:57.412384 | Job console starting
2026-08-13 20:07:57.422275 | Updating git repos
2026-08-13 20:07:57.452113 | Cloning repos into workspace
2026-08-13 20:07:57.488277 | Restoring repo states
2026-08-13 20:07:57.495970 | Merging changes
2026-08-13 20:07:57.815905 | Checking out repos
2026-08-13 20:07:57.854722 | Preparing playbooks
2026-08-13 20:07:58.818813 | Running Ansible setup
2026-08-13 20:08:02.507195 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-08-13 20:08:03.208834 | 
2026-08-13 20:08:03.209037 | PLAY [localhost]
2026-08-13 20:08:03.216486 | 
2026-08-13 20:08:03.216559 | TASK [Gathering Facts]
2026-08-13 20:08:04.127045 | localhost | ok
2026-08-13 20:08:04.140452 | 
2026-08-13 20:08:04.140665 | TASK [Setup log path fact]
2026-08-13 20:08:04.160492 | localhost | ok
2026-08-13 20:08:04.175344 | 
2026-08-13 20:08:04.175459 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-08-13 20:08:04.206631 | localhost | ok
2026-08-13 20:08:04.215831 | 
2026-08-13 20:08:04.215926 | TASK [emit-job-header : Print job information]
2026-08-13 20:08:04.247654 | # Job Information
2026-08-13 20:08:04.247864 | Ansible Version: 2.16.18
2026-08-13 20:08:04.247960 | Job: pre-commit
2026-08-13 20:08:04.248012 | Pipeline: check
2026-08-13 20:08:04.248045 | Executor: 2d72f0692154
2026-08-13 20:08:04.248074 | Triggered by: https://github.com/vexxhost/ansible-collection-containers/pull/147
2026-08-13 20:08:04.248107 | Event ID: 51084e40-9751-11f1-99ce-256097a5f637
2026-08-13 20:08:04.253898 | 
2026-08-13 20:08:04.254001 | LOOP [emit-job-header : Print node information]
2026-08-13 20:08:04.351563 | localhost | ok:
2026-08-13 20:08:04.351826 | localhost | # Node Information
2026-08-13 20:08:04.351877 | localhost | Inventory Hostname: ubuntu-noble
2026-08-13 20:08:04.351916 | localhost | Hostname: np0000189324
2026-08-13 20:08:04.351950 | localhost | Username: zuul
2026-08-13 20:08:04.351990 | localhost | Distro: Ubuntu 24.04
2026-08-13 20:08:04.352026 | localhost | Provider: yul1
2026-08-13 20:08:04.352059 | localhost | Region: ca-ymq-1
2026-08-13 20:08:04.352092 | localhost | Label: ubuntu-noble
2026-08-13 20:08:04.352124 | localhost | Product Name: OpenStack Nova
2026-08-13 20:08:04.352156 | localhost | Interface IP: 199.19.213.236
2026-08-13 20:08:04.364410 | 
2026-08-13 20:08:04.364588 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2026-08-13 20:08:04.782962 | localhost -> localhost | changed
2026-08-13 20:08:04.793770 | 
2026-08-13 20:08:04.793914 | TASK [log-inventory : Copy ansible inventory to logs dir]
2026-08-13 20:08:05.638828 | localhost -> localhost | changed
2026-08-13 20:08:05.651314 | 
2026-08-13 20:08:05.651388 | PLAY [all]
2026-08-13 20:08:05.659578 | 
2026-08-13 20:08:05.659667 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2026-08-13 20:08:05.896644 | ubuntu-noble -> localhost | ok
2026-08-13 20:08:05.905193 | 
2026-08-13 20:08:05.905272 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2026-08-13 20:08:05.940173 | ubuntu-noble | ok
2026-08-13 20:08:05.958009 | ubuntu-noble | included: /var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2026-08-13 20:08:05.966000 | 
2026-08-13 20:08:06.256142 | TASK [add-build-sshkey : Create Temp SSH key]
2026-08-13 20:08:08.055826 | ubuntu-noble -> localhost | Generating public/private rsa key pair.
2026-08-13 20:08:08.056017 | ubuntu-noble -> localhost | Your identification has been saved in /var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/work/f3c788a815734eaa82117aae4c54d047_id_rsa
2026-08-13 20:08:08.056061 | ubuntu-noble -> localhost | Your public key has been saved in /var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/work/f3c788a815734eaa82117aae4c54d047_id_rsa.pub
2026-08-13 20:08:08.056094 | ubuntu-noble -> localhost | The key fingerprint is:
2026-08-13 20:08:08.056126 | ubuntu-noble -> localhost | SHA256:ZEBBdL1MZto+D7njRRjwRqBKT2c8lhx/7CpmD2SxwmM zuul-build-sshkey
2026-08-13 20:08:08.056171 | ubuntu-noble -> localhost | The key's randomart image is:
2026-08-13 20:08:08.056204 | ubuntu-noble -> localhost | +---[RSA 3072]----+
2026-08-13 20:08:08.056238 | ubuntu-noble -> localhost | |     +*.=o.      |
2026-08-13 20:08:08.056270 | ubuntu-noble -> localhost | |       * B=.     |
2026-08-13 20:08:08.056300 | ubuntu-noble -> localhost | |    . o %B=.o    |
2026-08-13 20:08:08.056330 | ubuntu-noble -> localhost | |   . = *.=+=     |
2026-08-13 20:08:08.056359 | ubuntu-noble -> localhost | |    . E S...o    |
2026-08-13 20:08:08.056388 | ubuntu-noble -> localhost | |     . =  =o     |
2026-08-13 20:08:08.056417 | ubuntu-noble -> localhost | |        = .=.    |
2026-08-13 20:08:08.056446 | ubuntu-noble -> localhost | |       o +o..    |
2026-08-13 20:08:08.056479 | ubuntu-noble -> localhost | |         .o.     |
2026-08-13 20:08:08.056508 | ubuntu-noble -> localhost | +----[SHA256]-----+
2026-08-13 20:08:08.056569 | ubuntu-noble -> localhost | ok: Runtime: 0:00:01.374056
2026-08-13 20:08:08.065114 | 
2026-08-13 20:08:08.065199 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2026-08-13 20:08:08.090166 | ubuntu-noble | ok
2026-08-13 20:08:08.100279 | ubuntu-noble | included: /var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2026-08-13 20:08:08.108484 | 
2026-08-13 20:08:08.108547 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2026-08-13 20:08:08.132676 | ubuntu-noble | skipping: Conditional result was False
2026-08-13 20:08:08.140645 | 
2026-08-13 20:08:08.140741 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2026-08-13 20:08:08.692725 | ubuntu-noble | changed
2026-08-13 20:08:08.700826 | 
2026-08-13 20:08:08.700914 | TASK [add-build-sshkey : Make sure user has a .ssh]
2026-08-13 20:08:08.922856 | ubuntu-noble | ok
2026-08-13 20:08:08.929450 | 
2026-08-13 20:08:08.929535 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2026-08-13 20:08:09.523906 | ubuntu-noble | changed
2026-08-13 20:08:09.530671 | 
2026-08-13 20:08:09.530737 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2026-08-13 20:08:10.091411 | ubuntu-noble | changed
2026-08-13 20:08:10.097708 | 
2026-08-13 20:08:10.097771 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2026-08-13 20:08:10.122897 | ubuntu-noble | skipping: Conditional result was False
2026-08-13 20:08:10.128708 | 
2026-08-13 20:08:10.128777 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2026-08-13 20:08:10.524941 | ubuntu-noble -> localhost | changed
2026-08-13 20:08:10.542495 | 
2026-08-13 20:08:10.542586 | TASK [add-build-sshkey : Add back temp key]
2026-08-13 20:08:10.838867 | ubuntu-noble -> localhost | Identity added: /var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/work/f3c788a815734eaa82117aae4c54d047_id_rsa (zuul-build-sshkey)
2026-08-13 20:08:10.839107 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.013559
2026-08-13 20:08:10.846536 | 
2026-08-13 20:08:10.846638 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2026-08-13 20:08:11.204922 | ubuntu-noble | ok
2026-08-13 20:08:11.239365 | 
2026-08-13 20:08:11.239455 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2026-08-13 20:08:11.264049 | ubuntu-noble | skipping: Conditional result was False
2026-08-13 20:08:11.280863 | 
2026-08-13 20:08:11.280974 | TASK [prepare-workspace : Start zuul_console daemon.]
2026-08-13 20:08:11.658199 | ubuntu-noble | ok
2026-08-13 20:08:11.695803 | 
2026-08-13 20:08:11.695914 | TASK [prepare-workspace : Synchronize src repos to workspace directory.]
2026-08-13 20:08:12.463570 | ubuntu-noble | Output suppressed because no_log was given
2026-08-13 20:08:12.480131 | 
2026-08-13 20:08:12.480305 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them]
2026-08-13 20:08:12.720002 | ubuntu-noble | ok: "logs"
2026-08-13 20:08:12.720467 | ubuntu-noble | ok: All items complete
2026-08-13 20:08:12.720545 | 
2026-08-13 20:08:12.963540 | ubuntu-noble | ok: "artifacts"
2026-08-13 20:08:13.175718 | ubuntu-noble | ok: "docs"
2026-08-13 20:08:13.196175 | 
2026-08-13 20:08:13.196341 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist]
2026-08-13 20:08:13.457772 | ubuntu-noble | changed: "logs"
2026-08-13 20:08:13.665177 | ubuntu-noble | changed: "artifacts"
2026-08-13 20:08:13.871141 | ubuntu-noble | changed: "docs"
2026-08-13 20:08:13.888828 | 
2026-08-13 20:08:13.888987 | PLAY RECAP
2026-08-13 20:08:13.889053 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-08-13 20:08:13.889093 | ubuntu-noble | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0
2026-08-13 20:08:13.889122 | 
2026-08-13 20:08:14.026694 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-08-13 20:08:14.029003 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/pre.yaml@main]
2026-08-13 20:08:14.651165 | 
2026-08-13 20:08:14.651332 | PLAY [all]
2026-08-13 20:08:14.665055 | 
2026-08-13 20:08:14.665175 | TASK [setup-uv : Extract archive]
2026-08-13 20:08:17.425786 | ubuntu-noble | changed
2026-08-13 20:08:17.434857 | 
2026-08-13 20:08:17.434940 | TASK [setup-uv : Print version]
2026-08-13 20:08:17.902524 | ubuntu-noble | uv 0.8.13
2026-08-13 20:08:17.975518 | ubuntu-noble | ok: Runtime: 0:00:00.014997
2026-08-13 20:08:17.985396 | 
2026-08-13 20:08:17.985460 | PLAY RECAP
2026-08-13 20:08:17.985509 | ubuntu-noble | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-08-13 20:08:17.985533 | 
2026-08-13 20:08:18.188532 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/pre.yaml@main]
2026-08-13 20:08:18.191071 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/run.yaml@main]
2026-08-13 20:08:18.756940 | 
2026-08-13 20:08:18.757328 | PLAY [all]
2026-08-13 20:08:18.769460 | 
2026-08-13 20:08:18.769584 | TASK [Run "pre-commit"]
2026-08-13 20:08:19.445565 | ubuntu-noble | Downloading virtualenv (5.1MiB)
2026-08-13 20:08:19.512195 | ubuntu-noble |  Downloading virtualenv
2026-08-13 20:08:19.526367 | ubuntu-noble | Installed 10 packages in 13ms
2026-08-13 20:08:20.003244 | ubuntu-noble | [INFO] Initializing environment for https://github.com/pre-commit/pre-commit-hooks.
2026-08-13 20:08:20.662920 | ubuntu-noble | [WARNING] repo `https://github.com/pre-commit/pre-commit-hooks` uses deprecated stage names (commit, push) which will be removed in a future version.  Hint: often `pre-commit autoupdate --repo https://github.com/pre-commit/pre-commit-hooks` will fix this.  if it does not -- consider reporting an issue to that repo.
2026-08-13 20:08:20.668149 | ubuntu-noble | [INFO] Initializing environment for https://github.com/psf/black.
2026-08-13 20:08:21.375910 | ubuntu-noble | [INFO] Initializing environment for https://github.com/pycqa/flake8.
2026-08-13 20:08:22.394287 | ubuntu-noble | [INFO] Initializing environment for https://github.com/pycqa/isort.
2026-08-13 20:08:23.168698 | ubuntu-noble | [WARNING] repo `https://github.com/pycqa/isort` uses deprecated stage names (commit, merge-commit, push) which will be removed in a future version.  Hint: often `pre-commit autoupdate --repo https://github.com/pycqa/isort` will fix this.  if it does not -- consider reporting an issue to that repo.
2026-08-13 20:08:23.169921 | ubuntu-noble | [INFO] Initializing environment for https://github.com/ansible/ansible-lint.git.
2026-08-13 20:08:23.978074 | ubuntu-noble | [INFO] Initializing environment for https://github.com/ansible/ansible-lint.git:ansible-core>=2.16.0.
2026-08-13 20:08:24.879647 | ubuntu-noble | [INFO] Installing environment for https://github.com/pre-commit/pre-commit-hooks.
2026-08-13 20:08:24.879757 | ubuntu-noble | [INFO] Once installed this environment will be reused.
2026-08-13 20:08:24.879768 | ubuntu-noble | [INFO] This may take a few minutes...
2026-08-13 20:08:29.624436 | ubuntu-noble | [INFO] Installing environment for https://github.com/psf/black.
2026-08-13 20:08:29.624544 | ubuntu-noble | [INFO] Once installed this environment will be reused.
2026-08-13 20:08:29.624557 | ubuntu-noble | [INFO] This may take a few minutes...
2026-08-13 20:08:34.017085 | ubuntu-noble | [INFO] Installing environment for https://github.com/pycqa/flake8.
2026-08-13 20:08:34.017165 | ubuntu-noble | [INFO] Once installed this environment will be reused.
2026-08-13 20:08:34.017178 | ubuntu-noble | [INFO] This may take a few minutes...
2026-08-13 20:08:37.262500 | ubuntu-noble | [INFO] Installing environment for https://github.com/pycqa/isort.
2026-08-13 20:08:37.262583 | ubuntu-noble | [INFO] Once installed this environment will be reused.
2026-08-13 20:08:37.262603 | ubuntu-noble | [INFO] This may take a few minutes...
2026-08-13 20:08:40.044784 | ubuntu-noble | [INFO] Installing environment for https://github.com/ansible/ansible-lint.git.
2026-08-13 20:08:40.044871 | ubuntu-noble | [INFO] Once installed this environment will be reused.
2026-08-13 20:08:40.044887 | ubuntu-noble | [INFO] This may take a few minutes...
2026-08-13 20:08:51.805496 | ubuntu-noble | fix end of files.........................................................Passed
2026-08-13 20:08:51.882789 | ubuntu-noble | trim trailing whitespace.................................................Passed
2026-08-13 20:08:52.194355 | ubuntu-noble | black....................................................................Passed
2026-08-13 20:08:52.387100 | ubuntu-noble | flake8...................................................................Passed
2026-08-13 20:08:52.503669 | ubuntu-noble | isort....................................................................Passed
2026-08-13 20:09:13.212626 | ubuntu-noble | Ansible-lint.............................................................Passed
2026-08-13 20:09:13.374371 | ubuntu-noble | ok: Runtime: 0:00:54.080749
2026-08-13 20:09:13.376701 | 
2026-08-13 20:09:13.376769 | PLAY RECAP
2026-08-13 20:09:13.376833 | ubuntu-noble | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-08-13 20:09:13.376871 | 
2026-08-13 20:09:13.494745 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/run.yaml@main]
2026-08-13 20:09:13.496579 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-08-13 20:09:14.159440 | 
2026-08-13 20:09:14.159593 | PLAY [all]
2026-08-13 20:09:14.172131 | 
2026-08-13 20:09:14.172208 | TASK [fetch-output : Set log path for multiple nodes]
2026-08-13 20:09:14.219038 | ubuntu-noble | skipping: Conditional result was False
2026-08-13 20:09:14.226707 | 
2026-08-13 20:09:14.226815 | TASK [fetch-output : Set log path for single node]
2026-08-13 20:09:14.271928 | ubuntu-noble | ok
2026-08-13 20:09:14.276926 | 
2026-08-13 20:09:14.277008 | LOOP [fetch-output : Ensure local output dirs]
2026-08-13 20:09:14.937948 | ubuntu-noble -> localhost | ok: "/var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/work/logs"
2026-08-13 20:09:15.188378 | ubuntu-noble -> localhost | changed: "/var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/work/artifacts"
2026-08-13 20:09:15.399484 | ubuntu-noble -> localhost | changed: "/var/lib/zuul/builds/f3c788a815734eaa82117aae4c54d047/work/docs"
2026-08-13 20:09:15.428433 | 
2026-08-13 20:09:15.428644 | LOOP [fetch-output : Collect logs, artifacts and docs]
2026-08-13 20:09:16.069822 | ubuntu-noble | ok
2026-08-13 20:09:16.070088 | ubuntu-noble | changed: All items complete
2026-08-13 20:09:16.070133 | 
2026-08-13 20:09:16.547442 | ubuntu-noble | changed: .d..t...... ./
2026-08-13 20:09:17.046897 | ubuntu-noble | changed: .d..t...... ./
2026-08-13 20:09:17.070157 | 
2026-08-13 20:09:17.070311 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir]
2026-08-13 20:09:17.474232 | ubuntu-noble -> localhost | ok: Item: artifacts Runtime: 0:00:00.006699
2026-08-13 20:09:18.047664 | ubuntu-noble -> localhost | ok: Item: docs Runtime: 0:00:00.008048
2026-08-13 20:09:18.069902 | 
2026-08-13 20:09:18.070034 | PLAY [all]
2026-08-13 20:09:18.101288 | 
2026-08-13 20:09:18.101391 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2026-08-13 20:09:18.616587 | ubuntu-noble | changed
2026-08-13 20:09:18.624695 | 
2026-08-13 20:09:18.624761 | PLAY RECAP
2026-08-13 20:09:18.624816 | ubuntu-noble | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2026-08-13 20:09:18.624840 | 
2026-08-13 20:09:18.763571 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-08-13 20:09:18.766056 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main]
2026-08-13 20:09:19.461926 | 
2026-08-13 20:09:19.462055 | PLAY [localhost]
2026-08-13 20:09:19.473193 | 
2026-08-13 20:09:19.473281 | TASK [Generate Zuul manifest]
2026-08-13 20:09:19.493783 | localhost | ok
2026-08-13 20:09:19.510051 | 
2026-08-13 20:09:19.510143 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2026-08-13 20:09:19.909318 | localhost | changed
2026-08-13 20:09:19.921113 | 
2026-08-13 20:09:19.921201 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2026-08-13 20:09:19.984485 | localhost | ok
2026-08-13 20:09:19.993834 | 
2026-08-13 20:09:19.993905 | TASK [Upload logs]
2026-08-13 20:09:20.016404 | localhost | ok
2026-08-13 20:09:20.075712 | 
2026-08-13 20:09:20.104363 | TASK [Set zuul-log-path fact]
2026-08-13 20:09:20.128367 | localhost | ok
2026-08-13 20:09:20.143731 | 
2026-08-13 20:09:20.143812 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-08-13 20:09:20.177176 | localhost | ok
2026-08-13 20:09:20.185108 | 
2026-08-13 20:09:20.185183 | TASK [upload-logs : Create log directories]
2026-08-13 20:09:20.734208 | localhost | changed
2026-08-13 20:09:20.741433 | 
2026-08-13 20:09:20.741525 | TASK [upload-logs : Ensure logs are readable before uploading]
2026-08-13 20:09:21.186894 | localhost -> localhost | ok: Runtime: 0:00:00.004947
2026-08-13 20:09:21.193760 | 
2026-08-13 20:09:21.193852 | TASK [upload-logs : Upload logs to log server]
2026-08-13 20:09:21.707989 | localhost | Output suppressed because no_log was given
2026-08-13 20:09:21.712078 | 
2026-08-13 20:09:21.712166 | LOOP [upload-logs : Compress console log and json output]
2026-08-13 20:09:21.751182 | localhost | skipping: Conditional result was False
2026-08-13 20:09:21.758398 | localhost | skipping: Conditional result was False
2026-08-13 20:09:21.774185 | 
2026-08-13 20:09:21.774330 | LOOP [upload-logs : Upload compressed console log and json output]
2026-08-13 20:09:21.815507 | localhost | skipping: Conditional result was False
2026-08-13 20:09:21.815726 | 
2026-08-13 20:09:21.820813 | localhost | skipping: Conditional result was False
2026-08-13 20:09:21.832466 | 
2026-08-13 20:09:21.832642 | LOOP [upload-logs : Upload console log and json output]