2026-05-26 17:53:50.202273 | Job console starting 2026-05-26 17:53:50.218936 | Updating git repos 2026-05-26 17:53:50.301152 | Cloning repos into workspace 2026-05-26 17:53:50.414719 | Restoring repo states 2026-05-26 17:53:50.442917 | Merging changes 2026-05-26 17:53:51.111158 | Checking out repos 2026-05-26 17:53:51.143998 | Preparing playbooks 2026-05-26 17:53:52.079731 | Running Ansible setup 2026-05-26 17:53:57.838798 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-05-26 17:53:58.720227 | 2026-05-26 17:53:58.720374 | PLAY [Base pre] 2026-05-26 17:53:58.740962 | 2026-05-26 17:53:58.741093 | TASK [Setup log path fact] 2026-05-26 17:53:58.759729 | debian-bookworm | ok 2026-05-26 17:53:58.775927 | 2026-05-26 17:53:58.776057 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-26 17:53:58.804366 | debian-bookworm | ok 2026-05-26 17:53:58.814129 | 2026-05-26 17:53:58.814239 | TASK [emit-job-header : Print job information] 2026-05-26 17:53:58.853945 | # Job Information 2026-05-26 17:53:58.854199 | Ansible Version: 2.16.14 2026-05-26 17:53:58.854263 | Job: container-image-kolla-ansible-build-2025.2 2026-05-26 17:53:58.854326 | Pipeline: check 2026-05-26 17:53:58.854390 | Executor: 521e9411259a 2026-05-26 17:53:58.854454 | Triggered by: https://github.com/osism/container-image-kolla-ansible/pull/894 2026-05-26 17:53:58.854497 | Event ID: 2939ddc0-592b-11f1-88cc-c6625e9eb268 2026-05-26 17:53:58.862539 | 2026-05-26 17:53:58.862896 | LOOP [emit-job-header : Print node information] 2026-05-26 17:53:59.038649 | debian-bookworm | ok: 2026-05-26 17:53:59.038885 | debian-bookworm | # Node Information 2026-05-26 17:53:59.038925 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-05-26 17:53:59.038953 | debian-bookworm | Hostname: debian 2026-05-26 17:53:59.038977 | debian-bookworm | Username: zuul 2026-05-26 17:53:59.038999 | debian-bookworm | Distro: Debian 12.14 2026-05-26 17:53:59.039026 | debian-bookworm | Provider: regiocloud-a 2026-05-26 17:53:59.039049 | debian-bookworm | Region: 2026-05-26 17:53:59.039071 | debian-bookworm | Label: debian-bookworm 2026-05-26 17:53:59.039093 | debian-bookworm | Product Name: OpenStack Nova 2026-05-26 17:53:59.039114 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fee5:280 2026-05-26 17:53:59.056919 | 2026-05-26 17:53:59.057043 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-05-26 17:53:59.570826 | debian-bookworm -> localhost | changed 2026-05-26 17:53:59.582010 | 2026-05-26 17:53:59.582149 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-05-26 17:54:00.987434 | debian-bookworm -> localhost | changed 2026-05-26 17:54:01.010184 | 2026-05-26 17:54:01.010412 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-05-26 17:54:01.529725 | debian-bookworm -> localhost | ok 2026-05-26 17:54:01.540252 | 2026-05-26 17:54:01.540407 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-05-26 17:54:01.587505 | debian-bookworm | ok 2026-05-26 17:54:01.611634 | debian-bookworm | included: /var/lib/zuul/builds/815010224ae944979545b596f8df0c80/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-05-26 17:54:01.619759 | 2026-05-26 17:54:01.619944 | TASK [add-build-sshkey : Create Temp SSH key] 2026-05-26 17:54:03.621014 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-05-26 17:54:03.621245 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/815010224ae944979545b596f8df0c80/work/815010224ae944979545b596f8df0c80_id_rsa 2026-05-26 17:54:03.621287 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/815010224ae944979545b596f8df0c80/work/815010224ae944979545b596f8df0c80_id_rsa.pub 2026-05-26 17:54:03.621314 | debian-bookworm -> localhost | The key fingerprint is: 2026-05-26 17:54:03.621339 | debian-bookworm -> localhost | SHA256:M7IEs0c2Zh0WQSR/qq3rQTJx39orOOvndH0F/UAbr1Q zuul-build-sshkey 2026-05-26 17:54:03.621372 | debian-bookworm -> localhost | The key's randomart image is: 2026-05-26 17:54:03.621394 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-05-26 17:54:03.621416 | debian-bookworm -> localhost | | .oBo o E| 2026-05-26 17:54:03.621437 | debian-bookworm -> localhost | | = . . * | 2026-05-26 17:54:03.621457 | debian-bookworm -> localhost | | + B o . = o| 2026-05-26 17:54:03.621478 | debian-bookworm -> localhost | | @ o + . +.| 2026-05-26 17:54:03.621498 | debian-bookworm -> localhost | | + = S . . o| 2026-05-26 17:54:03.621527 | debian-bookworm -> localhost | | * = = . . | 2026-05-26 17:54:03.621549 | debian-bookworm -> localhost | | +.+ o . . | 2026-05-26 17:54:03.621570 | debian-bookworm -> localhost | | o+o. . . | 2026-05-26 17:54:03.621592 | debian-bookworm -> localhost | | o**... | 2026-05-26 17:54:03.621612 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-05-26 17:54:03.621675 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.069749 2026-05-26 17:54:03.628187 | 2026-05-26 17:54:03.628283 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-05-26 17:54:03.669875 | debian-bookworm | ok 2026-05-26 17:54:03.682391 | debian-bookworm | included: /var/lib/zuul/builds/815010224ae944979545b596f8df0c80/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-05-26 17:54:03.691212 | 2026-05-26 17:54:03.691298 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-05-26 17:54:03.731289 | debian-bookworm | skipping: Conditional result was False 2026-05-26 17:54:03.745737 | 2026-05-26 17:54:03.746133 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-05-26 17:54:04.453273 | debian-bookworm | changed 2026-05-26 17:54:04.459331 | 2026-05-26 17:54:04.459418 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-05-26 17:54:04.699006 | debian-bookworm | ok 2026-05-26 17:54:04.710064 | 2026-05-26 17:54:04.710177 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-05-26 17:54:05.453271 | debian-bookworm | changed 2026-05-26 17:54:05.464242 | 2026-05-26 17:54:05.464357 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-05-26 17:54:06.095995 | debian-bookworm | changed 2026-05-26 17:54:06.101484 | 2026-05-26 17:54:06.101572 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-05-26 17:54:06.124676 | debian-bookworm | skipping: Conditional result was False 2026-05-26 17:54:06.131062 | 2026-05-26 17:54:06.131166 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-05-26 17:54:06.761300 | debian-bookworm -> localhost | changed 2026-05-26 17:54:06.776577 | 2026-05-26 17:54:06.776708 | TASK [add-build-sshkey : Add back temp key] 2026-05-26 17:54:07.124624 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/815010224ae944979545b596f8df0c80/work/815010224ae944979545b596f8df0c80_id_rsa (zuul-build-sshkey) 2026-05-26 17:54:07.124922 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.018262 2026-05-26 17:54:07.133240 | 2026-05-26 17:54:07.133333 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-05-26 17:54:07.547664 | debian-bookworm | ok 2026-05-26 17:54:07.553615 | 2026-05-26 17:54:07.553824 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-05-26 17:54:07.578213 | debian-bookworm | skipping: Conditional result was False 2026-05-26 17:54:07.594078 | 2026-05-26 17:54:07.594204 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-05-26 17:54:08.038624 | debian-bookworm | ok 2026-05-26 17:54:08.050466 | 2026-05-26 17:54:08.050578 | TASK [validate-host : Define zuul_info_dir fact] 2026-05-26 17:54:08.079477 | debian-bookworm | ok 2026-05-26 17:54:08.084759 | 2026-05-26 17:54:08.084855 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-05-26 17:54:08.502529 | debian-bookworm -> localhost | ok 2026-05-26 17:54:08.509493 | 2026-05-26 17:54:08.509593 | TASK [validate-host : Collect information about the host] 2026-05-26 17:54:10.686509 | debian-bookworm | ok 2026-05-26 17:54:10.697051 | 2026-05-26 17:54:10.697162 | TASK [validate-host : Sanitize hostname] 2026-05-26 17:54:10.846702 | debian-bookworm | ok 2026-05-26 17:54:10.965468 | 2026-05-26 17:54:10.965629 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-05-26 17:54:11.749324 | debian-bookworm -> localhost | changed 2026-05-26 17:54:11.764623 | 2026-05-26 17:54:11.764867 | TASK [validate-host : Collect information about zuul worker] 2026-05-26 17:54:12.219885 | debian-bookworm | ok 2026-05-26 17:54:12.229127 | 2026-05-26 17:54:12.229305 | TASK [validate-host : Write out all zuul information for each host] 2026-05-26 17:54:12.784061 | debian-bookworm -> localhost | changed 2026-05-26 17:54:12.796724 | 2026-05-26 17:54:12.796842 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-05-26 17:54:13.097456 | debian-bookworm | ok 2026-05-26 17:54:13.106976 | 2026-05-26 17:54:13.107110 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-05-26 17:54:14.079905 | debian-bookworm | changed: 2026-05-26 17:54:14.080392 | debian-bookworm | cd+++++++++ src/ 2026-05-26 17:54:14.080462 | debian-bookworm | cd+++++++++ src/github.com/ 2026-05-26 17:54:14.080488 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-05-26 17:54:14.080511 | debian-bookworm | cd+++++++++ src/github.com/osism/container-image-kolla-ansible/ 2026-05-26 17:54:14.080533 | debian-bookworm | Containerfile 2026-05-26 17:54:14.080708 | debian-bookworm | localhost | ok: "/var/lib/zuul/builds/815010224ae944979545b596f8df0c80/work/logs" 2026-05-26 18:08:27.318654 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/815010224ae944979545b596f8df0c80/work/artifacts" 2026-05-26 18:08:27.648949 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/815010224ae944979545b596f8df0c80/work/docs" 2026-05-26 18:08:27.662820 | 2026-05-26 18:08:27.662952 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-05-26 18:08:28.441265 | debian-bookworm | changed: 2026-05-26 18:08:28.441482 | debian-bookworm | .d..t...... ./ 2026-05-26 18:08:28.441519 | debian-bookworm | >f+++++++++ sudo-debug.txt 2026-05-26 18:08:28.441554 | debian-bookworm | >f+++++++++ sudo-strace.log 2026-05-26 18:08:28.441585 | debian-bookworm | >f+++++++++ sudo-strace.log.time 2026-05-26 18:08:28.441623 | debian-bookworm | changed: All items complete 2026-05-26 18:08:28.441650 | 2026-05-26 18:08:29.038224 | debian-bookworm | changed: .d..t...... ./ 2026-05-26 18:08:29.771609 | debian-bookworm | changed: .d..t...... ./ 2026-05-26 18:08:29.793516 | 2026-05-26 18:08:29.793628 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-05-26 18:08:30.227806 | debian-bookworm -> localhost | ok: Item: artifacts Runtime: 0:00:00.005301 2026-05-26 18:08:30.501026 | debian-bookworm -> localhost | ok: Item: docs Runtime: 0:00:00.017147 2026-05-26 18:08:30.514498 | 2026-05-26 18:08:30.514662 | PLAY RECAP 2026-05-26 18:08:30.514715 | debian-bookworm | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-05-26 18:08:30.514739 | 2026-05-26 18:08:30.641139 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-05-26 18:08:30.642365 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-05-26 18:08:31.367338 | 2026-05-26 18:08:31.367539 | PLAY [Base post] 2026-05-26 18:08:31.380823 | 2026-05-26 18:08:31.380943 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-05-26 18:08:32.198606 | debian-bookworm | changed 2026-05-26 18:08:32.209220 | 2026-05-26 18:08:32.209375 | PLAY RECAP 2026-05-26 18:08:32.209517 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-05-26 18:08:32.209608 | 2026-05-26 18:08:32.354092 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-05-26 18:08:32.355385 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-05-26 18:08:33.319065 | 2026-05-26 18:08:33.319241 | PLAY [Base post-logs] 2026-05-26 18:08:33.330289 | 2026-05-26 18:08:33.330443 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-05-26 18:08:33.840152 | localhost | changed 2026-05-26 18:08:33.859736 | 2026-05-26 18:08:33.859993 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-05-26 18:08:33.902656 | localhost | ok 2026-05-26 18:08:33.911142 | 2026-05-26 18:08:33.911307 | TASK [Set zuul-log-path fact] 2026-05-26 18:08:33.944794 | localhost | ok 2026-05-26 18:08:33.963182 | 2026-05-26 18:08:33.963400 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-26 18:08:34.002944 | localhost | ok 2026-05-26 18:08:34.008622 | 2026-05-26 18:08:34.008768 | TASK [upload-logs : Create log directories] 2026-05-26 18:08:34.568908 | localhost | changed 2026-05-26 18:08:34.574890 | 2026-05-26 18:08:34.575084 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-05-26 18:08:35.130599 | localhost -> localhost | ok: Runtime: 0:00:00.007462 2026-05-26 18:08:35.139900 | 2026-05-26 18:08:35.140080 | TASK [upload-logs : Upload logs to log server] 2026-05-26 18:08:35.752561 | localhost | Output suppressed because no_log was given 2026-05-26 18:08:35.757067 | 2026-05-26 18:08:35.757263 | LOOP [upload-logs : Compress console log and json output] 2026-05-26 18:08:35.817742 | localhost | skipping: Conditional result was False 2026-05-26 18:08:35.822537 | localhost | skipping: Conditional result was False 2026-05-26 18:08:35.829685 | 2026-05-26 18:08:35.829863 | LOOP [upload-logs : Upload compressed console log and json output] 2026-05-26 18:08:35.877741 | localhost | skipping: Conditional result was False 2026-05-26 18:08:35.878355 | 2026-05-26 18:08:35.881992 | localhost | skipping: Conditional result was False 2026-05-26 18:08:35.895773 | 2026-05-26 18:08:35.896006 | LOOP [upload-logs : Upload console log and json output]