2026-04-29 03:01:37.774357 | Job console starting 2026-04-29 03:01:37.781284 | Updating git repos 2026-04-29 03:01:37.806892 | Cloning repos into workspace 2026-04-29 03:01:37.839458 | Restoring repo states 2026-04-29 03:01:37.843700 | Merging changes 2026-04-29 03:01:37.843714 | Checking out repos 2026-04-29 03:01:37.871421 | Preparing playbooks 2026-04-29 03:01:38.864234 | Running Ansible setup 2026-04-29 03:01:43.597077 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-04-29 03:01:44.499253 | 2026-04-29 03:01:44.499499 | PLAY [Base pre] 2026-04-29 03:01:44.517057 | 2026-04-29 03:01:44.517210 | TASK [Setup log path fact] 2026-04-29 03:01:44.546628 | debian-bookworm | ok 2026-04-29 03:01:44.563266 | 2026-04-29 03:01:44.563419 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-29 03:01:44.605631 | debian-bookworm | ok 2026-04-29 03:01:44.622298 | 2026-04-29 03:01:44.622436 | TASK [emit-job-header : Print job information] 2026-04-29 03:01:44.662516 | # Job Information 2026-04-29 03:01:44.662708 | Ansible Version: 2.16.14 2026-04-29 03:01:44.662763 | Job: python-black 2026-04-29 03:01:44.662795 | Pipeline: periodic-daily 2026-04-29 03:01:44.662818 | Executor: 521e9411259a 2026-04-29 03:01:44.662860 | Triggered by: https://github.com/osism/openstack-configuration-reference 2026-04-29 03:01:44.662883 | Event ID: 8ebd32d28b1f4726b91b4bb6e10dd600 2026-04-29 03:01:44.668179 | 2026-04-29 03:01:44.668304 | LOOP [emit-job-header : Print node information] 2026-04-29 03:01:44.784930 | debian-bookworm | ok: 2026-04-29 03:01:44.785214 | debian-bookworm | # Node Information 2026-04-29 03:01:44.785260 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-04-29 03:01:44.785287 | debian-bookworm | Hostname: debian 2026-04-29 03:01:44.785310 | debian-bookworm | Username: zuul 2026-04-29 03:01:44.785331 | debian-bookworm | Distro: Debian 12.13 2026-04-29 03:01:44.785356 | debian-bookworm | Provider: regiocloud-a 2026-04-29 03:01:44.785383 | debian-bookworm | Region: 2026-04-29 03:01:44.785405 | debian-bookworm | Label: debian-bookworm 2026-04-29 03:01:44.785425 | debian-bookworm | Product Name: OpenStack Nova 2026-04-29 03:01:44.785445 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe05:2b1 2026-04-29 03:01:44.806326 | 2026-04-29 03:01:44.806465 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-29 03:01:45.276600 | debian-bookworm -> localhost | changed 2026-04-29 03:01:45.283436 | 2026-04-29 03:01:45.283535 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-29 03:01:47.222614 | debian-bookworm -> localhost | changed 2026-04-29 03:01:47.233054 | 2026-04-29 03:01:47.233157 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-29 03:01:47.758534 | debian-bookworm -> localhost | ok 2026-04-29 03:01:47.769313 | 2026-04-29 03:01:47.769420 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-29 03:01:47.841072 | debian-bookworm | ok 2026-04-29 03:01:47.879444 | debian-bookworm | included: /var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-29 03:01:47.890110 | 2026-04-29 03:01:47.890207 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-29 03:01:51.184287 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-04-29 03:01:51.185315 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/work/66315d7f12ce4304b6a05ba12637bea8_id_rsa 2026-04-29 03:01:51.185386 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/work/66315d7f12ce4304b6a05ba12637bea8_id_rsa.pub 2026-04-29 03:01:51.185418 | debian-bookworm -> localhost | The key fingerprint is: 2026-04-29 03:01:51.185444 | debian-bookworm -> localhost | SHA256:WzaRvdSUASGtE27rWP4mmXTxxXMVLt9AEWFPLXUpuFo zuul-build-sshkey 2026-04-29 03:01:51.185467 | debian-bookworm -> localhost | The key's randomart image is: 2026-04-29 03:01:51.185496 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-04-29 03:01:51.185518 | debian-bookworm -> localhost | | ..+oOOB| 2026-04-29 03:01:51.185541 | debian-bookworm -> localhost | | .=.*+++| 2026-04-29 03:01:51.185562 | debian-bookworm -> localhost | | .oo+.++o| 2026-04-29 03:01:51.185582 | debian-bookworm -> localhost | | =E..oo=| 2026-04-29 03:01:51.185602 | debian-bookworm -> localhost | | S.*o.o o+| 2026-04-29 03:01:51.185629 | debian-bookworm -> localhost | | =+.. . | 2026-04-29 03:01:51.185650 | debian-bookworm -> localhost | | .* + | 2026-04-29 03:01:51.185671 | debian-bookworm -> localhost | | . * . | 2026-04-29 03:01:51.185692 | debian-bookworm -> localhost | | +. | 2026-04-29 03:01:51.185713 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-04-29 03:01:51.185780 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.776223 2026-04-29 03:01:51.192003 | 2026-04-29 03:01:51.192092 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-29 03:01:51.231082 | debian-bookworm | ok 2026-04-29 03:01:51.249678 | debian-bookworm | included: /var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-29 03:01:51.259207 | 2026-04-29 03:01:51.259315 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-29 03:01:51.282873 | debian-bookworm | skipping: Conditional result was False 2026-04-29 03:01:51.288770 | 2026-04-29 03:01:51.288866 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-29 03:01:51.988840 | debian-bookworm | changed 2026-04-29 03:01:51.994027 | 2026-04-29 03:01:51.994112 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-29 03:01:52.365240 | debian-bookworm | ok 2026-04-29 03:01:52.370545 | 2026-04-29 03:01:52.370635 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-29 03:01:53.189552 | debian-bookworm | changed 2026-04-29 03:01:53.196048 | 2026-04-29 03:01:53.196140 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-29 03:01:54.050015 | debian-bookworm | changed 2026-04-29 03:01:54.056073 | 2026-04-29 03:01:54.056169 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-29 03:01:54.069312 | debian-bookworm | skipping: Conditional result was False 2026-04-29 03:01:54.076325 | 2026-04-29 03:01:54.076430 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-29 03:01:54.586135 | debian-bookworm -> localhost | changed 2026-04-29 03:01:54.596853 | 2026-04-29 03:01:54.596963 | TASK [add-build-sshkey : Add back temp key] 2026-04-29 03:01:55.449955 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/work/66315d7f12ce4304b6a05ba12637bea8_id_rsa (zuul-build-sshkey) 2026-04-29 03:01:55.450165 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.032692 2026-04-29 03:01:55.458094 | 2026-04-29 03:01:55.458200 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-29 03:01:56.015880 | debian-bookworm | ok 2026-04-29 03:01:56.021361 | 2026-04-29 03:01:56.021455 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-29 03:01:56.055378 | debian-bookworm | skipping: Conditional result was False 2026-04-29 03:01:56.071245 | 2026-04-29 03:01:56.071347 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-04-29 03:01:56.673001 | debian-bookworm | ok 2026-04-29 03:01:56.694261 | 2026-04-29 03:01:56.694369 | TASK [validate-host : Define zuul_info_dir fact] 2026-04-29 03:01:56.737881 | debian-bookworm | ok 2026-04-29 03:01:56.747046 | 2026-04-29 03:01:56.747156 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-04-29 03:01:57.286639 | debian-bookworm -> localhost | ok 2026-04-29 03:01:57.302168 | 2026-04-29 03:01:57.302304 | TASK [validate-host : Collect information about the host] 2026-04-29 03:01:59.190467 | debian-bookworm | ok 2026-04-29 03:01:59.214090 | 2026-04-29 03:01:59.214199 | TASK [validate-host : Sanitize hostname] 2026-04-29 03:01:59.323113 | debian-bookworm | ok 2026-04-29 03:01:59.447406 | 2026-04-29 03:01:59.447516 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-04-29 03:02:01.021621 | debian-bookworm -> localhost | changed 2026-04-29 03:02:01.027171 | 2026-04-29 03:02:01.027263 | TASK [validate-host : Collect information about zuul worker] 2026-04-29 03:02:01.611399 | debian-bookworm | ok 2026-04-29 03:02:01.615101 | 2026-04-29 03:02:01.615183 | TASK [validate-host : Write out all zuul information for each host] 2026-04-29 03:02:02.723734 | debian-bookworm -> localhost | changed 2026-04-29 03:02:02.731565 | 2026-04-29 03:02:02.731658 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-04-29 03:02:03.010024 | debian-bookworm | ok 2026-04-29 03:02:03.014599 | 2026-04-29 03:02:03.014677 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-04-29 03:02:04.445038 | debian-bookworm | changed: 2026-04-29 03:02:04.445179 | debian-bookworm | cd+++++++++ src/ 2026-04-29 03:02:04.445206 | debian-bookworm | cd+++++++++ src/github.com/ 2026-04-29 03:02:04.445225 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-04-29 03:02:04.445243 | debian-bookworm | cd+++++++++ src/github.com/osism/openstack-configuration-reference/ 2026-04-29 03:02:04.445259 | debian-bookworm | Containerfile 2026-04-29 03:02:04.445352 | debian-bookworm | localhost | ok: "/var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/work/logs" 2026-04-29 03:02:34.417698 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/work/artifacts" 2026-04-29 03:02:34.720032 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/66315d7f12ce4304b6a05ba12637bea8/work/docs" 2026-04-29 03:02:34.733834 | 2026-04-29 03:02:34.733971 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-04-29 03:02:35.576550 | debian-bookworm | changed: 2026-04-29 03:02:35.576821 | debian-bookworm | >f+++++++++ sudo-debug.txt 2026-04-29 03:02:35.576863 | debian-bookworm | >f+++++++++ sudo-strace.log 2026-04-29 03:02:35.576893 | debian-bookworm | >f+++++++++ sudo-strace.log.time 2026-04-29 03:02:35.576940 | debian-bookworm | changed: All items complete 2026-04-29 03:02:35.576968 | 2026-04-29 03:02:36.176006 | debian-bookworm | changed: .d..t...... ./ 2026-04-29 03:02:36.788974 | debian-bookworm | changed: .d..t...... ./ 2026-04-29 03:02:36.816876 | 2026-04-29 03:02:36.817030 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-04-29 03:02:36.845433 | debian-bookworm | skipping: Conditional result was False 2026-04-29 03:02:36.849789 | debian-bookworm | skipping: Conditional result was False 2026-04-29 03:02:36.859490 | 2026-04-29 03:02:36.859582 | PLAY RECAP 2026-04-29 03:02:36.859634 | debian-bookworm | ok: 3 changed: 2 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0 2026-04-29 03:02:36.859658 | 2026-04-29 03:02:37.020380 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-04-29 03:02:37.021267 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-04-29 03:02:37.959639 | 2026-04-29 03:02:37.959824 | PLAY [Base post] 2026-04-29 03:02:37.975438 | 2026-04-29 03:02:37.976463 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-29 03:02:38.850612 | debian-bookworm | changed 2026-04-29 03:02:38.871224 | 2026-04-29 03:02:38.871357 | PLAY RECAP 2026-04-29 03:02:38.871424 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-29 03:02:38.871484 | 2026-04-29 03:02:39.368953 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-04-29 03:02:39.370940 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-29 03:02:41.576504 | 2026-04-29 03:02:41.577107 | PLAY [Base post-logs] 2026-04-29 03:02:41.621240 | 2026-04-29 03:02:41.621371 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-29 03:02:42.570299 | localhost | changed 2026-04-29 03:02:42.580795 | 2026-04-29 03:02:42.580912 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-29 03:02:42.641483 | localhost | ok 2026-04-29 03:02:42.643995 | 2026-04-29 03:02:42.644074 | TASK [Set zuul-log-path fact] 2026-04-29 03:02:42.667864 | localhost | ok 2026-04-29 03:02:42.674230 | 2026-04-29 03:02:42.674314 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-29 03:02:42.708330 | localhost | ok 2026-04-29 03:02:42.712040 | 2026-04-29 03:02:42.712125 | TASK [upload-logs : Create log directories] 2026-04-29 03:02:43.182485 | localhost | changed 2026-04-29 03:02:43.186390 | 2026-04-29 03:02:43.186479 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-29 03:02:43.805593 | localhost -> localhost | ok: Runtime: 0:00:00.004128 2026-04-29 03:02:43.809119 | 2026-04-29 03:02:43.809218 | TASK [upload-logs : Upload logs to log server] 2026-04-29 03:02:44.619704 | localhost | Output suppressed because no_log was given 2026-04-29 03:02:44.621302 | 2026-04-29 03:02:44.621387 | LOOP [upload-logs : Compress console log and json output] 2026-04-29 03:02:44.702775 | localhost | skipping: Conditional result was False 2026-04-29 03:02:44.707998 | localhost | skipping: Conditional result was False 2026-04-29 03:02:44.717026 | 2026-04-29 03:02:44.717121 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-29 03:02:44.778044 | localhost | skipping: Conditional result was False 2026-04-29 03:02:44.778263 | 2026-04-29 03:02:44.781928 | localhost | skipping: Conditional result was False 2026-04-29 03:02:44.793152 | 2026-04-29 03:02:44.793254 | LOOP [upload-logs : Upload console log and json output]