2026-05-09 03:19:11.881228 | Job console starting 2026-05-09 03:19:11.890676 | Updating git repos 2026-05-09 03:19:11.916898 | Cloning repos into workspace 2026-05-09 03:19:11.977194 | Restoring repo states 2026-05-09 03:19:11.986235 | Merging changes 2026-05-09 03:19:11.986248 | Checking out repos 2026-05-09 03:19:12.047538 | Preparing playbooks 2026-05-09 03:19:13.244079 | Running Ansible setup 2026-05-09 03:19:18.854298 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-05-09 03:19:20.157047 | 2026-05-09 03:19:20.157194 | PLAY [Base pre] 2026-05-09 03:19:20.201023 | 2026-05-09 03:19:20.201151 | TASK [Setup log path fact] 2026-05-09 03:19:20.220375 | debian-bookworm | ok 2026-05-09 03:19:20.237823 | 2026-05-09 03:19:20.237957 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-09 03:19:20.271991 | debian-bookworm | ok 2026-05-09 03:19:20.297675 | 2026-05-09 03:19:20.297790 | TASK [emit-job-header : Print job information] 2026-05-09 03:19:20.347499 | # Job Information 2026-05-09 03:19:20.347665 | Ansible Version: 2.16.14 2026-05-09 03:19:20.347699 | Job: kolla-operations-mixin-ouput-ensure-git-checkin 2026-05-09 03:19:20.347733 | Pipeline: periodic-daily 2026-05-09 03:19:20.347755 | Executor: 521e9411259a 2026-05-09 03:19:20.347776 | Triggered by: https://github.com/osism/kolla-operations 2026-05-09 03:19:20.347797 | Event ID: c56762cbfa3b4259af8642c726a90962 2026-05-09 03:19:20.352948 | 2026-05-09 03:19:20.353039 | LOOP [emit-job-header : Print node information] 2026-05-09 03:19:20.573380 | debian-bookworm | ok: 2026-05-09 03:19:20.573600 | debian-bookworm | # Node Information 2026-05-09 03:19:20.573643 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-05-09 03:19:20.573678 | debian-bookworm | Hostname: debian 2026-05-09 03:19:20.573700 | debian-bookworm | Username: zuul 2026-05-09 03:19:20.573721 | debian-bookworm | Distro: Debian 12.13 2026-05-09 03:19:20.573745 | debian-bookworm | Provider: regiocloud-a 2026-05-09 03:19:20.573766 | debian-bookworm | Region: 2026-05-09 03:19:20.573788 | debian-bookworm | Label: debian-bookworm 2026-05-09 03:19:20.573808 | debian-bookworm | Product Name: OpenStack Nova 2026-05-09 03:19:20.573828 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe70:c606 2026-05-09 03:19:20.585769 | 2026-05-09 03:19:20.585907 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-05-09 03:19:21.191085 | debian-bookworm -> localhost | changed 2026-05-09 03:19:21.196968 | 2026-05-09 03:19:21.197065 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-05-09 03:19:23.115285 | debian-bookworm -> localhost | changed 2026-05-09 03:19:23.124365 | 2026-05-09 03:19:23.124464 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-05-09 03:19:23.492596 | debian-bookworm -> localhost | ok 2026-05-09 03:19:23.498674 | 2026-05-09 03:19:23.498778 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-05-09 03:19:23.518206 | debian-bookworm | ok 2026-05-09 03:19:23.533999 | debian-bookworm | included: /var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-05-09 03:19:23.540132 | 2026-05-09 03:19:23.540216 | TASK [add-build-sshkey : Create Temp SSH key] 2026-05-09 03:19:25.138173 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-05-09 03:19:25.138362 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/work/860898cdb20a45d5a41ee6c2260da543_id_rsa 2026-05-09 03:19:25.138395 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/work/860898cdb20a45d5a41ee6c2260da543_id_rsa.pub 2026-05-09 03:19:25.138418 | debian-bookworm -> localhost | The key fingerprint is: 2026-05-09 03:19:25.138575 | debian-bookworm -> localhost | SHA256:0Z99c0uDZkoGsBpfXDvWPAAcIO+3dU/ek9qyllWnT7E zuul-build-sshkey 2026-05-09 03:19:25.138624 | debian-bookworm -> localhost | The key's randomart image is: 2026-05-09 03:19:25.138647 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-05-09 03:19:25.138666 | debian-bookworm -> localhost | | . ooooo | 2026-05-09 03:19:25.138699 | debian-bookworm -> localhost | | o +o. = | 2026-05-09 03:19:25.138718 | debian-bookworm -> localhost | | . o.+.+ + | 2026-05-09 03:19:25.138735 | debian-bookworm -> localhost | | = ..o..oo.o| 2026-05-09 03:19:25.138752 | debian-bookworm -> localhost | | . oS. +o=.*B| 2026-05-09 03:19:25.138772 | debian-bookworm -> localhost | | . = = *EO| 2026-05-09 03:19:25.138790 | debian-bookworm -> localhost | | . . oO.| 2026-05-09 03:19:25.138807 | debian-bookworm -> localhost | | +o o| 2026-05-09 03:19:25.138825 | debian-bookworm -> localhost | | .oo. | 2026-05-09 03:19:25.139572 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-05-09 03:19:25.139634 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.109504 2026-05-09 03:19:25.145276 | 2026-05-09 03:19:25.145382 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-05-09 03:19:25.194199 | debian-bookworm | ok 2026-05-09 03:19:25.214802 | debian-bookworm | included: /var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-05-09 03:19:25.244888 | 2026-05-09 03:19:25.245596 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-05-09 03:19:25.324969 | debian-bookworm | skipping: Conditional result was False 2026-05-09 03:19:25.331995 | 2026-05-09 03:19:25.332097 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-05-09 03:19:25.994163 | debian-bookworm | changed 2026-05-09 03:19:25.998544 | 2026-05-09 03:19:25.998618 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-05-09 03:19:26.279721 | debian-bookworm | ok 2026-05-09 03:19:26.298217 | 2026-05-09 03:19:26.298320 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-05-09 03:19:27.068399 | debian-bookworm | changed 2026-05-09 03:19:27.075314 | 2026-05-09 03:19:27.075446 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-05-09 03:19:27.837214 | debian-bookworm | changed 2026-05-09 03:19:27.842849 | 2026-05-09 03:19:27.842947 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-05-09 03:19:27.886224 | debian-bookworm | skipping: Conditional result was False 2026-05-09 03:19:27.892169 | 2026-05-09 03:19:27.892268 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-05-09 03:19:28.624947 | debian-bookworm -> localhost | changed 2026-05-09 03:19:28.642302 | 2026-05-09 03:19:28.642479 | TASK [add-build-sshkey : Add back temp key] 2026-05-09 03:19:29.195380 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/work/860898cdb20a45d5a41ee6c2260da543_id_rsa (zuul-build-sshkey) 2026-05-09 03:19:29.195624 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.025231 2026-05-09 03:19:29.208472 | 2026-05-09 03:19:29.208597 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-05-09 03:19:29.641601 | debian-bookworm | ok 2026-05-09 03:19:29.646523 | 2026-05-09 03:19:29.646614 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-05-09 03:19:29.691596 | debian-bookworm | skipping: Conditional result was False 2026-05-09 03:19:29.709711 | 2026-05-09 03:19:29.710577 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-05-09 03:19:30.182881 | debian-bookworm | ok 2026-05-09 03:19:30.195115 | 2026-05-09 03:19:30.195229 | TASK [validate-host : Define zuul_info_dir fact] 2026-05-09 03:19:30.233631 | debian-bookworm | ok 2026-05-09 03:19:30.245318 | 2026-05-09 03:19:30.245488 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-05-09 03:19:30.532537 | debian-bookworm -> localhost | ok 2026-05-09 03:19:30.539090 | 2026-05-09 03:19:30.539207 | TASK [validate-host : Collect information about the host] 2026-05-09 03:19:31.827010 | debian-bookworm | ok 2026-05-09 03:19:31.856200 | 2026-05-09 03:19:31.860961 | TASK [validate-host : Sanitize hostname] 2026-05-09 03:19:32.065820 | debian-bookworm | ok 2026-05-09 03:19:32.176508 | 2026-05-09 03:19:32.176638 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-05-09 03:19:33.051561 | debian-bookworm -> localhost | changed 2026-05-09 03:19:33.059309 | 2026-05-09 03:19:33.059429 | TASK [validate-host : Collect information about zuul worker] 2026-05-09 03:19:33.897174 | debian-bookworm | ok 2026-05-09 03:19:33.902702 | 2026-05-09 03:19:33.902792 | TASK [validate-host : Write out all zuul information for each host] 2026-05-09 03:19:35.038009 | debian-bookworm -> localhost | changed 2026-05-09 03:19:35.053759 | 2026-05-09 03:19:35.053853 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-05-09 03:19:35.386309 | debian-bookworm | ok 2026-05-09 03:19:35.396195 | 2026-05-09 03:19:35.396284 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-05-09 03:19:36.704653 | debian-bookworm | changed: 2026-05-09 03:19:36.704808 | debian-bookworm | cd+++++++++ src/ 2026-05-09 03:19:36.704836 | debian-bookworm | cd+++++++++ src/github.com/ 2026-05-09 03:19:36.704857 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-05-09 03:19:36.704876 | debian-bookworm | cd+++++++++ src/github.com/osism/kolla-operations/ 2026-05-09 03:19:36.704893 | debian-bookworm | Containerfile 2026-05-09 03:19:36.707652 | debian-bookworm | localhost | ok: "/var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/work/logs" 2026-05-09 03:21:22.365837 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/work/artifacts" 2026-05-09 03:21:22.666604 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/860898cdb20a45d5a41ee6c2260da543/work/docs" 2026-05-09 03:21:22.682772 | 2026-05-09 03:21:22.682958 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-05-09 03:21:23.502086 | debian-bookworm | changed: 2026-05-09 03:21:23.502361 | debian-bookworm | >f+++++++++ sudo-debug.txt 2026-05-09 03:21:23.502402 | debian-bookworm | >f+++++++++ sudo-strace.log 2026-05-09 03:21:23.502435 | debian-bookworm | >f+++++++++ sudo-strace.log.time 2026-05-09 03:21:23.502487 | debian-bookworm | changed: All items complete 2026-05-09 03:21:23.502517 | 2026-05-09 03:21:24.104994 | debian-bookworm | changed: .d..t...... ./ 2026-05-09 03:21:24.721039 | debian-bookworm | changed: .d..t...... ./ 2026-05-09 03:21:24.753686 | 2026-05-09 03:21:24.753869 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-05-09 03:21:24.781920 | debian-bookworm | skipping: Conditional result was False 2026-05-09 03:21:24.785839 | debian-bookworm | skipping: Conditional result was False 2026-05-09 03:21:24.800993 | 2026-05-09 03:21:24.801101 | PLAY RECAP 2026-05-09 03:21:24.801170 | debian-bookworm | ok: 3 changed: 2 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0 2026-05-09 03:21:24.801205 | 2026-05-09 03:21:24.932736 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-05-09 03:21:24.934793 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-05-09 03:21:25.741477 | 2026-05-09 03:21:25.741655 | PLAY [Base post] 2026-05-09 03:21:25.755731 | 2026-05-09 03:21:25.755872 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-05-09 03:21:26.363835 | debian-bookworm | changed 2026-05-09 03:21:26.373434 | 2026-05-09 03:21:26.373574 | PLAY RECAP 2026-05-09 03:21:26.373750 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-05-09 03:21:26.373840 | 2026-05-09 03:21:26.502803 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-05-09 03:21:26.504975 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-05-09 03:21:27.331345 | 2026-05-09 03:21:27.331534 | PLAY [Base post-logs] 2026-05-09 03:21:27.343940 | 2026-05-09 03:21:27.344103 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-05-09 03:21:27.839758 | localhost | changed 2026-05-09 03:21:27.850579 | 2026-05-09 03:21:27.850747 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-05-09 03:21:27.889153 | localhost | ok 2026-05-09 03:21:27.895608 | 2026-05-09 03:21:27.895741 | TASK [Set zuul-log-path fact] 2026-05-09 03:21:27.913350 | localhost | ok 2026-05-09 03:21:27.926394 | 2026-05-09 03:21:27.926576 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-09 03:21:27.959567 | localhost | ok 2026-05-09 03:21:27.969200 | 2026-05-09 03:21:27.969560 | TASK [upload-logs : Create log directories] 2026-05-09 03:21:28.523496 | localhost | changed 2026-05-09 03:21:28.528078 | 2026-05-09 03:21:28.528227 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-05-09 03:21:29.051968 | localhost -> localhost | ok: Runtime: 0:00:00.007581 2026-05-09 03:21:29.056235 | 2026-05-09 03:21:29.056408 | TASK [upload-logs : Upload logs to log server] 2026-05-09 03:21:29.631141 | localhost | Output suppressed because no_log was given 2026-05-09 03:21:29.633704 | 2026-05-09 03:21:29.633843 | LOOP [upload-logs : Compress console log and json output] 2026-05-09 03:21:29.692538 | localhost | skipping: Conditional result was False 2026-05-09 03:21:29.699002 | localhost | skipping: Conditional result was False 2026-05-09 03:21:29.710212 | 2026-05-09 03:21:29.710371 | LOOP [upload-logs : Upload compressed console log and json output] 2026-05-09 03:21:29.772800 | localhost | skipping: Conditional result was False 2026-05-09 03:21:29.773091 | 2026-05-09 03:21:29.778020 | localhost | skipping: Conditional result was False 2026-05-09 03:21:29.795232 | 2026-05-09 03:21:29.795450 | LOOP [upload-logs : Upload console log and json output]