2026-04-17 10:43:52.518280 | Job console starting 2026-04-17 10:43:52.533781 | Updating git repos 2026-04-17 10:43:52.568789 | Cloning repos into workspace 2026-04-17 10:43:55.274472 | Restoring repo states 2026-04-17 10:43:55.291011 | Merging changes 2026-04-17 10:43:55.782340 | Checking out repos 2026-04-17 10:43:56.633245 | Preparing playbooks 2026-04-17 10:44:06.225869 | Running Ansible setup 2026-04-17 10:44:10.891584 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-17 10:44:11.524397 | 2026-04-17 10:44:11.524533 | PLAY [localhost] 2026-04-17 10:44:11.532268 | 2026-04-17 10:44:11.532353 | TASK [Gathering Facts] 2026-04-17 10:44:12.366219 | localhost | ok 2026-04-17 10:44:12.372840 | 2026-04-17 10:44:12.372914 | TASK [Setup log path fact] 2026-04-17 10:44:12.389626 | localhost | ok 2026-04-17 10:44:12.404114 | 2026-04-17 10:44:12.404253 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-17 10:44:12.435808 | localhost | ok 2026-04-17 10:44:12.458962 | 2026-04-17 10:44:12.459109 | TASK [emit-job-header : Print job information] 2026-04-17 10:44:12.488654 | # Job Information 2026-04-17 10:44:12.488823 | Ansible Version: 2.16.16 2026-04-17 10:44:12.488855 | Job: pre-commit 2026-04-17 10:44:12.488876 | Pipeline: check 2026-04-17 10:44:12.488896 | Executor: 0a8996d2b663 2026-04-17 10:44:12.488916 | Triggered by: https://github.com/vexxhost/ansible-collection-containers/pull/114 2026-04-17 10:44:12.488938 | Event ID: 34b67640-3a4a-11f1-9787-0a435e8cfe42 2026-04-17 10:44:12.491681 | 2026-04-17 10:44:12.491743 | LOOP [emit-job-header : Print node information] 2026-04-17 10:44:12.582597 | localhost | ok: 2026-04-17 10:44:12.583003 | localhost | # Node Information 2026-04-17 10:44:12.583035 | localhost | Inventory Hostname: ubuntu-noble 2026-04-17 10:44:12.583058 | localhost | Hostname: np0000167098 2026-04-17 10:44:12.583078 | localhost | Username: zuul 2026-04-17 10:44:12.583100 | localhost | Distro: Ubuntu 24.04 2026-04-17 10:44:12.583119 | localhost | Provider: yul1 2026-04-17 10:44:12.583138 | localhost | Region: ca-ymq-1 2026-04-17 10:44:12.583156 | localhost | Label: ubuntu-noble 2026-04-17 10:44:12.583190 | localhost | Product Name: OpenStack Nova 2026-04-17 10:44:12.583211 | localhost | Interface IP: 199.19.213.163 2026-04-17 10:44:12.593049 | 2026-04-17 10:44:12.593177 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-17 10:44:13.109984 | localhost -> localhost | changed 2026-04-17 10:44:13.114810 | 2026-04-17 10:44:13.114904 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-17 10:44:14.127410 | localhost -> localhost | changed 2026-04-17 10:44:14.133678 | 2026-04-17 10:44:14.133744 | PLAY [all] 2026-04-17 10:44:14.141942 | 2026-04-17 10:44:14.142008 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-17 10:44:14.379059 | ubuntu-noble -> localhost | ok 2026-04-17 10:44:14.386095 | 2026-04-17 10:44:14.386162 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-17 10:44:14.407975 | ubuntu-noble | ok 2026-04-17 10:44:14.431236 | ubuntu-noble | included: /var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-17 10:44:14.437895 | 2026-04-17 10:44:14.437960 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-17 10:44:15.483267 | ubuntu-noble -> localhost | Generating public/private rsa key pair. 2026-04-17 10:44:15.483488 | ubuntu-noble -> localhost | Your identification has been saved in /var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/work/a1fee207e0cc416e96dd92eb075f73e6_id_rsa 2026-04-17 10:44:15.483533 | ubuntu-noble -> localhost | Your public key has been saved in /var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/work/a1fee207e0cc416e96dd92eb075f73e6_id_rsa.pub 2026-04-17 10:44:15.483566 | ubuntu-noble -> localhost | The key fingerprint is: 2026-04-17 10:44:15.483597 | ubuntu-noble -> localhost | SHA256:14Mag/9ADMlQemfh6hhDuhMIzNFRorgwEs5n2WtpjHI zuul-build-sshkey 2026-04-17 10:44:15.483639 | ubuntu-noble -> localhost | The key's randomart image is: 2026-04-17 10:44:15.483670 | ubuntu-noble -> localhost | +---[RSA 3072]----+ 2026-04-17 10:44:15.483704 | ubuntu-noble -> localhost | |...o+o. . | 2026-04-17 10:44:15.483735 | ubuntu-noble -> localhost | |*.o.++ o . | 2026-04-17 10:44:15.483764 | ubuntu-noble -> localhost | |** +o.= + | 2026-04-17 10:44:15.483793 | ubuntu-noble -> localhost | |++ooo.oB o | 2026-04-17 10:44:15.483822 | ubuntu-noble -> localhost | |o.oEo*o S o o | 2026-04-17 10:44:15.483851 | ubuntu-noble -> localhost | | ooo= o = . | 2026-04-17 10:44:15.483879 | ubuntu-noble -> localhost | | o . . + | 2026-04-17 10:44:15.483908 | ubuntu-noble -> localhost | | . o | 2026-04-17 10:44:15.483941 | ubuntu-noble -> localhost | | . | 2026-04-17 10:44:15.483970 | ubuntu-noble -> localhost | +----[SHA256]-----+ 2026-04-17 10:44:15.484037 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.627243 2026-04-17 10:44:15.491841 | 2026-04-17 10:44:15.491902 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-17 10:44:15.520767 | ubuntu-noble | ok 2026-04-17 10:44:15.531446 | ubuntu-noble | included: /var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-17 10:44:15.540171 | 2026-04-17 10:44:15.540325 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-17 10:44:15.565850 | ubuntu-noble | skipping: Conditional result was False 2026-04-17 10:44:15.575763 | 2026-04-17 10:44:15.575874 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-17 10:44:16.123771 | ubuntu-noble | changed 2026-04-17 10:44:16.132128 | 2026-04-17 10:44:16.132208 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-17 10:44:16.349933 | ubuntu-noble | ok 2026-04-17 10:44:16.356972 | 2026-04-17 10:44:16.357040 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-17 10:44:16.950182 | ubuntu-noble | changed 2026-04-17 10:44:16.955621 | 2026-04-17 10:44:16.955684 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-17 10:44:17.505715 | ubuntu-noble | changed 2026-04-17 10:44:17.512493 | 2026-04-17 10:44:17.512765 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-17 10:44:17.539994 | ubuntu-noble | skipping: Conditional result was False 2026-04-17 10:44:17.550170 | 2026-04-17 10:44:17.554113 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-17 10:44:17.938489 | ubuntu-noble -> localhost | changed 2026-04-17 10:44:17.951604 | 2026-04-17 10:44:17.951687 | TASK [add-build-sshkey : Add back temp key] 2026-04-17 10:44:18.244470 | ubuntu-noble -> localhost | Identity added: /var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/work/a1fee207e0cc416e96dd92eb075f73e6_id_rsa (zuul-build-sshkey) 2026-04-17 10:44:18.244672 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.010300 2026-04-17 10:44:18.251883 | 2026-04-17 10:44:18.251949 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-17 10:44:18.594397 | ubuntu-noble | ok 2026-04-17 10:44:18.601348 | 2026-04-17 10:44:18.601408 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-17 10:44:18.626148 | ubuntu-noble | skipping: Conditional result was False 2026-04-17 10:44:18.642651 | 2026-04-17 10:44:18.642734 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-04-17 10:44:19.029066 | ubuntu-noble | ok 2026-04-17 10:44:19.035413 | 2026-04-17 10:44:19.035515 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-04-17 10:44:19.901425 | ubuntu-noble | Output suppressed because no_log was given 2026-04-17 10:44:19.922001 | 2026-04-17 10:44:19.922093 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-04-17 10:44:20.227700 | ubuntu-noble | ok: "logs" 2026-04-17 10:44:20.227881 | ubuntu-noble | ok: All items complete 2026-04-17 10:44:20.227918 | 2026-04-17 10:44:20.377239 | ubuntu-noble | ok: "artifacts" 2026-04-17 10:44:20.612204 | ubuntu-noble | ok: "docs" 2026-04-17 10:44:20.624936 | 2026-04-17 10:44:20.625124 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-04-17 10:44:20.842271 | ubuntu-noble | changed: "logs" 2026-04-17 10:44:21.035905 | ubuntu-noble | changed: "artifacts" 2026-04-17 10:44:21.224228 | ubuntu-noble | changed: "docs" 2026-04-17 10:44:21.235021 | 2026-04-17 10:44:21.235119 | PLAY RECAP 2026-04-17 10:44:21.235164 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-17 10:44:21.235214 | ubuntu-noble | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-04-17 10:44:21.235244 | 2026-04-17 10:44:21.382184 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-17 10:44:21.383570 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/pre.yaml@main] 2026-04-17 10:44:21.979053 | 2026-04-17 10:44:21.979237 | PLAY [all] 2026-04-17 10:44:21.991951 | 2026-04-17 10:44:21.992051 | TASK [setup-uv : Extract archive] 2026-04-17 10:44:24.491177 | ubuntu-noble | changed 2026-04-17 10:44:24.499420 | 2026-04-17 10:44:24.499512 | TASK [setup-uv : Print version] 2026-04-17 10:44:24.937564 | ubuntu-noble | uv 0.8.13 2026-04-17 10:44:25.056060 | ubuntu-noble | ok: Runtime: 0:00:00.015842 2026-04-17 10:44:25.064714 | 2026-04-17 10:44:25.064888 | PLAY RECAP 2026-04-17 10:44:25.064981 | ubuntu-noble | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-17 10:44:25.065020 | 2026-04-17 10:44:25.176502 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/pre.yaml@main] 2026-04-17 10:44:25.177667 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/run.yaml@main] 2026-04-17 10:44:25.797888 | 2026-04-17 10:44:25.798063 | PLAY [all] 2026-04-17 10:44:25.810336 | 2026-04-17 10:44:25.810425 | TASK [Run "pre-commit"] 2026-04-17 10:44:26.402613 | ubuntu-noble | Downloading virtualenv (5.6MiB) 2026-04-17 10:44:26.494618 | ubuntu-noble | Downloading virtualenv 2026-04-17 10:44:26.507258 | ubuntu-noble | Installed 10 packages in 12ms 2026-04-17 10:44:26.896087 | ubuntu-noble | [INFO] Initializing environment for https://github.com/pre-commit/pre-commit-hooks. 2026-04-17 10:44:27.481087 | 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-04-17 10:44:27.487913 | ubuntu-noble | [INFO] Initializing environment for https://github.com/psf/black. 2026-04-17 10:44:28.000838 | ubuntu-noble | [INFO] Initializing environment for https://github.com/pycqa/flake8. 2026-04-17 10:44:28.406517 | ubuntu-noble | [INFO] Initializing environment for https://github.com/pycqa/isort. 2026-04-17 10:44:28.847300 | 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-04-17 10:44:28.848752 | ubuntu-noble | [INFO] Initializing environment for https://github.com/ansible/ansible-lint.git. 2026-04-17 10:44:29.417957 | ubuntu-noble | [INFO] Initializing environment for https://github.com/ansible/ansible-lint.git:ansible-core>=2.16.0. 2026-04-17 10:44:30.318365 | ubuntu-noble | [INFO] Installing environment for https://github.com/pre-commit/pre-commit-hooks. 2026-04-17 10:44:30.318435 | ubuntu-noble | [INFO] Once installed this environment will be reused. 2026-04-17 10:44:30.318446 | ubuntu-noble | [INFO] This may take a few minutes... 2026-04-17 10:44:34.646949 | ubuntu-noble | [INFO] Installing environment for https://github.com/psf/black. 2026-04-17 10:44:34.647203 | ubuntu-noble | [INFO] Once installed this environment will be reused. 2026-04-17 10:44:34.647221 | ubuntu-noble | [INFO] This may take a few minutes... 2026-04-17 10:44:39.165709 | ubuntu-noble | [INFO] Installing environment for https://github.com/pycqa/flake8. 2026-04-17 10:44:39.165795 | ubuntu-noble | [INFO] Once installed this environment will be reused. 2026-04-17 10:44:39.165807 | ubuntu-noble | [INFO] This may take a few minutes... 2026-04-17 10:44:42.712208 | ubuntu-noble | [INFO] Installing environment for https://github.com/pycqa/isort. 2026-04-17 10:44:42.712289 | ubuntu-noble | [INFO] Once installed this environment will be reused. 2026-04-17 10:44:42.712297 | ubuntu-noble | [INFO] This may take a few minutes... 2026-04-17 10:44:45.735490 | ubuntu-noble | [INFO] Installing environment for https://github.com/ansible/ansible-lint.git. 2026-04-17 10:44:45.735552 | ubuntu-noble | [INFO] Once installed this environment will be reused. 2026-04-17 10:44:45.735570 | ubuntu-noble | [INFO] This may take a few minutes... 2026-04-17 10:44:58.455284 | ubuntu-noble | fix end of files.........................................................Passed 2026-04-17 10:44:58.529573 | ubuntu-noble | trim trailing whitespace.................................................Passed 2026-04-17 10:44:58.811923 | ubuntu-noble | black....................................................................Passed 2026-04-17 10:44:59.015394 | ubuntu-noble | flake8...................................................................Passed 2026-04-17 10:44:59.145182 | ubuntu-noble | isort....................................................................Passed 2026-04-17 10:45:15.704368 | ubuntu-noble | Ansible-lint.............................................................Passed 2026-04-17 10:45:16.023368 | ubuntu-noble | ok: Runtime: 0:00:49.542691 2026-04-17 10:45:16.031074 | 2026-04-17 10:45:16.031228 | PLAY RECAP 2026-04-17 10:45:16.031392 | ubuntu-noble | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-17 10:45:16.031450 | 2026-04-17 10:45:16.142632 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/pre-commit/run.yaml@main] 2026-04-17 10:45:16.143805 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-17 10:45:16.717184 | 2026-04-17 10:45:16.717319 | PLAY [all] 2026-04-17 10:45:16.729185 | 2026-04-17 10:45:16.729289 | TASK [fetch-output : Set log path for multiple nodes] 2026-04-17 10:45:16.774068 | ubuntu-noble | skipping: Conditional result was False 2026-04-17 10:45:16.783356 | 2026-04-17 10:45:16.783484 | TASK [fetch-output : Set log path for single node] 2026-04-17 10:45:16.830118 | ubuntu-noble | ok 2026-04-17 10:45:16.835168 | 2026-04-17 10:45:16.835236 | LOOP [fetch-output : Ensure local output dirs] 2026-04-17 10:45:17.203271 | ubuntu-noble -> localhost | ok: "/var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/work/logs" 2026-04-17 10:45:17.411348 | ubuntu-noble -> localhost | changed: "/var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/work/artifacts" 2026-04-17 10:45:17.653419 | ubuntu-noble -> localhost | changed: "/var/lib/zuul/builds/a1fee207e0cc416e96dd92eb075f73e6/work/docs" 2026-04-17 10:45:17.672020 | 2026-04-17 10:45:17.672092 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-04-17 10:45:18.316064 | ubuntu-noble | changed: .d..t...... ./ 2026-04-17 10:45:18.316272 | ubuntu-noble | changed: All items complete 2026-04-17 10:45:18.316299 | 2026-04-17 10:45:18.804919 | ubuntu-noble | changed: .d..t...... ./ 2026-04-17 10:45:19.235701 | ubuntu-noble | changed: .d..t...... ./ 2026-04-17 10:45:19.248043 | 2026-04-17 10:45:19.248109 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-04-17 10:45:19.638301 | ubuntu-noble -> localhost | ok: Item: artifacts Runtime: 0:00:00.006724 2026-04-17 10:45:19.845637 | ubuntu-noble -> localhost | ok: Item: docs Runtime: 0:00:00.006075 2026-04-17 10:45:19.866649 | 2026-04-17 10:45:19.866707 | PLAY [all] 2026-04-17 10:45:19.872947 | 2026-04-17 10:45:19.873026 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-17 10:45:20.322286 | ubuntu-noble | changed 2026-04-17 10:45:20.328398 | 2026-04-17 10:45:20.328446 | PLAY RECAP 2026-04-17 10:45:20.328489 | ubuntu-noble | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-17 10:45:20.328510 | 2026-04-17 10:45:20.456355 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-17 10:45:20.458415 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-17 10:45:21.015308 | 2026-04-17 10:45:21.015560 | PLAY [localhost] 2026-04-17 10:45:21.029318 | 2026-04-17 10:45:21.029390 | TASK [Generate Zuul manifest] 2026-04-17 10:45:21.052240 | localhost | ok 2026-04-17 10:45:21.070452 | 2026-04-17 10:45:21.070532 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-17 10:45:21.397200 | localhost | changed 2026-04-17 10:45:21.410286 | 2026-04-17 10:45:21.410361 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-17 10:45:21.442242 | localhost | ok 2026-04-17 10:45:21.450863 | 2026-04-17 10:45:21.450936 | TASK [Upload logs] 2026-04-17 10:45:21.482589 | localhost | ok 2026-04-17 10:45:21.541128 | 2026-04-17 10:45:21.541225 | TASK [Set zuul-log-path fact] 2026-04-17 10:45:21.563835 | localhost | ok 2026-04-17 10:45:21.575813 | 2026-04-17 10:45:21.575895 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-17 10:45:21.607985 | localhost | ok 2026-04-17 10:45:21.616221 | 2026-04-17 10:45:21.616287 | TASK [upload-logs : Create log directories] 2026-04-17 10:45:22.029757 | localhost | changed 2026-04-17 10:45:22.034583 | 2026-04-17 10:45:22.034680 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-17 10:45:22.429985 | localhost -> localhost | ok: Runtime: 0:00:00.005618 2026-04-17 10:45:22.437605 | 2026-04-17 10:45:22.437673 | TASK [upload-logs : Upload logs to log server] 2026-04-17 10:45:22.900616 | localhost | Output suppressed because no_log was given 2026-04-17 10:45:22.905705 | 2026-04-17 10:45:22.905797 | LOOP [upload-logs : Compress console log and json output] 2026-04-17 10:45:22.951223 | localhost | skipping: Conditional result was False 2026-04-17 10:45:22.957854 | localhost | skipping: Conditional result was False 2026-04-17 10:45:22.970634 | 2026-04-17 10:45:22.970822 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-17 10:45:23.009408 | localhost | skipping: Conditional result was False 2026-04-17 10:45:23.009768 | 2026-04-17 10:45:23.013625 | localhost | skipping: Conditional result was False 2026-04-17 10:45:23.023554 | 2026-04-17 10:45:23.023676 | LOOP [upload-logs : Upload console log and json output]