2025-08-21 20:47:01.667248 | Job console starting 2025-08-21 20:47:01.694655 | Updating git repos 2025-08-21 20:47:01.720436 | Cloning repos into workspace 2025-08-21 20:47:01.790611 | Restoring repo states 2025-08-21 20:47:01.799341 | Merging changes 2025-08-21 20:47:02.301810 | Checking out repos 2025-08-21 20:47:02.331946 | Preparing playbooks 2025-08-21 20:47:02.897973 | Running Ansible setup 2025-08-21 20:47:07.081422 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-08-21 20:47:07.774029 | 2025-08-21 20:47:07.774168 | PLAY [Base pre] 2025-08-21 20:47:07.788921 | 2025-08-21 20:47:07.789038 | TASK [Setup log path fact] 2025-08-21 20:47:07.807260 | debian-bookworm | ok 2025-08-21 20:47:07.821622 | 2025-08-21 20:47:07.821737 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-08-21 20:47:07.850733 | debian-bookworm | ok 2025-08-21 20:47:07.860374 | 2025-08-21 20:47:07.860483 | TASK [emit-job-header : Print job information] 2025-08-21 20:47:07.900123 | # Job Information 2025-08-21 20:47:07.900301 | Ansible Version: 2.16.14 2025-08-21 20:47:07.900336 | Job: metalbox-mirror-debian-packages 2025-08-21 20:47:07.900369 | Pipeline: check 2025-08-21 20:47:07.900392 | Executor: 521e9411259a 2025-08-21 20:47:07.900413 | Triggered by: https://github.com/osism/metalbox/pull/189 2025-08-21 20:47:07.900436 | Event ID: f8502f60-7ecf-11f0-8429-97837e6c90d0 2025-08-21 20:47:07.905347 | 2025-08-21 20:47:07.905461 | LOOP [emit-job-header : Print node information] 2025-08-21 20:47:08.016121 | debian-bookworm | ok: 2025-08-21 20:47:08.016381 | debian-bookworm | # Node Information 2025-08-21 20:47:08.016437 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-08-21 20:47:08.016477 | debian-bookworm | Hostname: debian 2025-08-21 20:47:08.016513 | debian-bookworm | Username: zuul 2025-08-21 20:47:08.016548 | debian-bookworm | Distro: Debian 12.11 2025-08-21 20:47:08.016586 | debian-bookworm | Provider: regiocloud-a 2025-08-21 20:47:08.016620 | debian-bookworm | Region: 2025-08-21 20:47:08.016654 | debian-bookworm | Label: debian-bookworm 2025-08-21 20:47:08.016686 | debian-bookworm | Product Name: OpenStack Nova 2025-08-21 20:47:08.016718 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe2c:4db6 2025-08-21 20:47:08.033636 | 2025-08-21 20:47:08.033771 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-08-21 20:47:08.487922 | debian-bookworm -> localhost | changed 2025-08-21 20:47:08.495444 | 2025-08-21 20:47:08.495577 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-08-21 20:47:09.475272 | debian-bookworm -> localhost | changed 2025-08-21 20:47:09.486109 | 2025-08-21 20:47:09.486236 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-08-21 20:47:09.753573 | debian-bookworm -> localhost | ok 2025-08-21 20:47:09.759943 | 2025-08-21 20:47:09.760069 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-08-21 20:47:09.788723 | debian-bookworm | ok 2025-08-21 20:47:09.811528 | debian-bookworm | included: /var/lib/zuul/builds/04123f7456ce49f599bb88d23c0909b2/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-08-21 20:47:09.822272 | 2025-08-21 20:47:09.822407 | TASK [add-build-sshkey : Create Temp SSH key] 2025-08-21 20:47:11.271739 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-08-21 20:47:11.271960 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/04123f7456ce49f599bb88d23c0909b2/work/04123f7456ce49f599bb88d23c0909b2_id_rsa 2025-08-21 20:47:11.271999 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/04123f7456ce49f599bb88d23c0909b2/work/04123f7456ce49f599bb88d23c0909b2_id_rsa.pub 2025-08-21 20:47:11.272026 | debian-bookworm -> localhost | The key fingerprint is: 2025-08-21 20:47:11.272051 | debian-bookworm -> localhost | SHA256:GCrTUkeJMM6eaHwIyFGOkXfhQ8iRk7FNylAvRmGzSWg zuul-build-sshkey 2025-08-21 20:47:11.272074 | debian-bookworm -> localhost | The key's randomart image is: 2025-08-21 20:47:11.272122 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-08-21 20:47:11.272146 | debian-bookworm -> localhost | | +O%B=o. | 2025-08-21 20:47:11.272167 | debian-bookworm -> localhost | |oE@O&o. | 2025-08-21 20:47:11.272187 | debian-bookworm -> localhost | |+o+X+=o | 2025-08-21 20:47:11.272207 | debian-bookworm -> localhost | |ooo+.o.o | 2025-08-21 20:47:11.272226 | debian-bookworm -> localhost | |.+*.o . S | 2025-08-21 20:47:11.272252 | debian-bookworm -> localhost | |. .+ | 2025-08-21 20:47:11.272273 | debian-bookworm -> localhost | | | 2025-08-21 20:47:11.272293 | debian-bookworm -> localhost | | | 2025-08-21 20:47:11.272314 | debian-bookworm -> localhost | | | 2025-08-21 20:47:11.272334 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-08-21 20:47:11.272384 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.984449 2025-08-21 20:47:11.279187 | 2025-08-21 20:47:11.279293 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-08-21 20:47:11.307362 | debian-bookworm | ok 2025-08-21 20:47:11.316752 | debian-bookworm | included: /var/lib/zuul/builds/04123f7456ce49f599bb88d23c0909b2/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-08-21 20:47:11.325813 | 2025-08-21 20:47:11.325912 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-08-21 20:47:11.349306 | debian-bookworm | skipping: Conditional result was False 2025-08-21 20:47:11.355363 | 2025-08-21 20:47:11.355464 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-08-21 20:47:12.041061 | debian-bookworm | changed 2025-08-21 20:47:12.050481 | 2025-08-21 20:47:12.050624 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-08-21 20:47:12.327212 | debian-bookworm | ok 2025-08-21 20:47:12.336556 | 2025-08-21 20:47:12.336710 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-08-21 20:47:13.026199 | debian-bookworm | changed 2025-08-21 20:47:13.039394 | 2025-08-21 20:47:13.039542 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-08-21 20:47:13.699205 | debian-bookworm | changed 2025-08-21 20:47:13.704780 | 2025-08-21 20:47:13.704901 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-08-21 20:47:13.738682 | debian-bookworm | skipping: Conditional result was False 2025-08-21 20:47:13.745897 | 2025-08-21 20:47:13.746029 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-08-21 20:47:14.198619 | debian-bookworm -> localhost | changed 2025-08-21 20:47:14.216479 | 2025-08-21 20:47:14.216610 | TASK [add-build-sshkey : Add back temp key] 2025-08-21 20:47:14.565680 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/04123f7456ce49f599bb88d23c0909b2/work/04123f7456ce49f599bb88d23c0909b2_id_rsa (zuul-build-sshkey) 2025-08-21 20:47:14.565942 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.019676 2025-08-21 20:47:14.574221 | 2025-08-21 20:47:14.574350 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-08-21 20:47:15.000054 | debian-bookworm | ok 2025-08-21 20:47:15.005473 | 2025-08-21 20:47:15.005593 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-08-21 20:47:15.039572 | debian-bookworm | skipping: Conditional result was False 2025-08-21 20:47:15.052640 | 2025-08-21 20:47:15.052773 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-08-21 20:47:15.504959 | debian-bookworm | ok 2025-08-21 20:47:15.521756 | 2025-08-21 20:47:15.521916 | TASK [validate-host : Define zuul_info_dir fact] 2025-08-21 20:47:15.561915 | debian-bookworm | ok 2025-08-21 20:47:15.568376 | 2025-08-21 20:47:15.568504 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-08-21 20:47:15.866763 | debian-bookworm -> localhost | ok 2025-08-21 20:47:15.880339 | 2025-08-21 20:47:15.880507 | TASK [validate-host : Collect information about the host] 2025-08-21 20:47:16.997785 | debian-bookworm | ok 2025-08-21 20:47:17.008523 | 2025-08-21 20:47:17.008662 | TASK [validate-host : Sanitize hostname] 2025-08-21 20:47:17.130821 | debian-bookworm | ok 2025-08-21 20:47:17.173348 | 2025-08-21 20:47:17.173553 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-08-21 20:47:17.721485 | debian-bookworm -> localhost | changed 2025-08-21 20:47:17.732270 | 2025-08-21 20:47:17.732425 | TASK [validate-host : Collect information about zuul worker] 2025-08-21 20:47:18.140466 | debian-bookworm | ok 2025-08-21 20:47:18.145960 | 2025-08-21 20:47:18.146094 | TASK [validate-host : Write out all zuul information for each host] 2025-08-21 20:47:18.679649 | debian-bookworm -> localhost | changed 2025-08-21 20:47:18.694699 | 2025-08-21 20:47:18.694868 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-08-21 20:47:18.977919 | debian-bookworm | ok 2025-08-21 20:47:18.987469 | 2025-08-21 20:47:18.987610 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-08-21 20:47:19.824458 | debian-bookworm | changed: 2025-08-21 20:47:19.824680 | debian-bookworm | cd+++++++++ src/ 2025-08-21 20:47:19.824715 | debian-bookworm | cd+++++++++ src/github.com/ 2025-08-21 20:47:19.824739 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-08-21 20:47:19.824761 | debian-bookworm | cd+++++++++ src/github.com/osism/metalbox/ 2025-08-21 20:47:19.824781 | debian-bookworm | localhost | ok: Runtime: 0:00:00.006962 2025-08-21 20:48:12.963254 | 2025-08-21 20:48:12.963369 | TASK [upload-logs : Upload logs to log server] 2025-08-21 20:48:13.508305 | localhost | Output suppressed because no_log was given 2025-08-21 20:48:13.511856 | 2025-08-21 20:48:13.512034 | LOOP [upload-logs : Compress console log and json output] 2025-08-21 20:48:13.556713 | localhost | skipping: Conditional result was False 2025-08-21 20:48:13.564427 | localhost | skipping: Conditional result was False 2025-08-21 20:48:13.573331 | 2025-08-21 20:48:13.573561 | LOOP [upload-logs : Upload compressed console log and json output] 2025-08-21 20:48:13.616331 | localhost | skipping: Conditional result was False 2025-08-21 20:48:13.616588 | 2025-08-21 20:48:13.623060 | localhost | skipping: Conditional result was False 2025-08-21 20:48:13.634518 | 2025-08-21 20:48:13.634733 | LOOP [upload-logs : Upload console log and json output]