2025-10-31 19:47:26.691755 | Job console starting 2025-10-31 19:47:26.742224 | Updating git repos 2025-10-31 19:47:26.782698 | Cloning repos into workspace 2025-10-31 19:47:26.831964 | Restoring repo states 2025-10-31 19:47:26.842573 | Merging changes 2025-10-31 19:47:27.295156 | Checking out repos 2025-10-31 19:47:27.340789 | Preparing playbooks 2025-10-31 19:47:28.388598 | Running Ansible setup 2025-10-31 19:47:33.228864 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-10-31 19:47:34.018773 | 2025-10-31 19:47:34.018995 | PLAY [Base pre] 2025-10-31 19:47:34.041353 | 2025-10-31 19:47:34.041507 | TASK [Setup log path fact] 2025-10-31 19:47:34.061509 | debian-bookworm | ok 2025-10-31 19:47:34.079599 | 2025-10-31 19:47:34.079765 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-10-31 19:47:34.110097 | debian-bookworm | ok 2025-10-31 19:47:34.120590 | 2025-10-31 19:47:34.120719 | TASK [emit-job-header : Print job information] 2025-10-31 19:47:34.160342 | # Job Information 2025-10-31 19:47:34.160615 | Ansible Version: 2.16.14 2025-10-31 19:47:34.160654 | Job: container-image-inventory-reconciler-build 2025-10-31 19:47:34.160696 | Pipeline: check 2025-10-31 19:47:34.160724 | Executor: 521e9411259a 2025-10-31 19:47:34.160745 | Triggered by: https://github.com/osism/container-image-inventory-reconciler/pull/447 2025-10-31 19:47:34.160766 | Event ID: 683eec40-b692-11f0-9251-514953f740e5 2025-10-31 19:47:34.166567 | 2025-10-31 19:47:34.166694 | LOOP [emit-job-header : Print node information] 2025-10-31 19:47:34.275568 | debian-bookworm | ok: 2025-10-31 19:47:34.275863 | debian-bookworm | # Node Information 2025-10-31 19:47:34.275906 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-10-31 19:47:34.275931 | debian-bookworm | Hostname: debian 2025-10-31 19:47:34.275953 | debian-bookworm | Username: zuul 2025-10-31 19:47:34.275975 | debian-bookworm | Distro: Debian 12.12 2025-10-31 19:47:34.276005 | debian-bookworm | Provider: regiocloud-a 2025-10-31 19:47:34.276030 | debian-bookworm | Region: 2025-10-31 19:47:34.276052 | debian-bookworm | Label: debian-bookworm 2025-10-31 19:47:34.276072 | debian-bookworm | Product Name: OpenStack Nova 2025-10-31 19:47:34.276091 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fef0:d21b 2025-10-31 19:47:34.297446 | 2025-10-31 19:47:34.297591 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-10-31 19:47:34.816692 | debian-bookworm -> localhost | changed 2025-10-31 19:47:34.822565 | 2025-10-31 19:47:34.822646 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-10-31 19:47:35.983200 | debian-bookworm -> localhost | changed 2025-10-31 19:47:35.991660 | 2025-10-31 19:47:35.991752 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-10-31 19:47:36.247089 | debian-bookworm -> localhost | ok 2025-10-31 19:47:36.252904 | 2025-10-31 19:47:36.252997 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-10-31 19:47:36.269160 | debian-bookworm | ok 2025-10-31 19:47:36.297445 | debian-bookworm | included: /var/lib/zuul/builds/c5c8f6057d26422f92e269019bdf9bfe/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-10-31 19:47:36.302621 | 2025-10-31 19:47:36.302691 | TASK [add-build-sshkey : Create Temp SSH key] 2025-10-31 19:47:37.372283 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-10-31 19:47:37.372444 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/c5c8f6057d26422f92e269019bdf9bfe/work/c5c8f6057d26422f92e269019bdf9bfe_id_rsa 2025-10-31 19:47:37.372474 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/c5c8f6057d26422f92e269019bdf9bfe/work/c5c8f6057d26422f92e269019bdf9bfe_id_rsa.pub 2025-10-31 19:47:37.372495 | debian-bookworm -> localhost | The key fingerprint is: 2025-10-31 19:47:37.372515 | debian-bookworm -> localhost | SHA256:3sTtuwG5zqIJQ2AbiHllXIOU0NHdoXrBOyZE4hdfYgM zuul-build-sshkey 2025-10-31 19:47:37.372543 | debian-bookworm -> localhost | The key's randomart image is: 2025-10-31 19:47:37.372560 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-10-31 19:47:37.372577 | debian-bookworm -> localhost | | .=**Eo+.o. | 2025-10-31 19:47:37.372594 | debian-bookworm -> localhost | |.o +=o.*.=. | 2025-10-31 19:47:37.372610 | debian-bookworm -> localhost | |+ = . o = | 2025-10-31 19:47:37.372626 | debian-bookworm -> localhost | | o + o . + o | 2025-10-31 19:47:37.372641 | debian-bookworm -> localhost | | . . o S = . | 2025-10-31 19:47:37.372660 | debian-bookworm -> localhost | | . = + + | 2025-10-31 19:47:37.372677 | debian-bookworm -> localhost | | o . o o | 2025-10-31 19:47:37.372692 | debian-bookworm -> localhost | | o ..o o | 2025-10-31 19:47:37.372709 | debian-bookworm -> localhost | | o. .o o. | 2025-10-31 19:47:37.372725 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-10-31 19:47:37.372762 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.472960 2025-10-31 19:47:37.377715 | 2025-10-31 19:47:37.377794 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-10-31 19:47:37.403692 | debian-bookworm | ok 2025-10-31 19:47:37.414360 | debian-bookworm | included: /var/lib/zuul/builds/c5c8f6057d26422f92e269019bdf9bfe/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-10-31 19:47:37.432630 | 2025-10-31 19:47:37.432792 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-10-31 19:47:37.457137 | debian-bookworm | skipping: Conditional result was False 2025-10-31 19:47:37.463216 | 2025-10-31 19:47:37.463308 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-10-31 19:47:38.100511 | debian-bookworm | changed 2025-10-31 19:47:38.106997 | 2025-10-31 19:47:38.107085 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-10-31 19:47:38.349629 | debian-bookworm | ok 2025-10-31 19:47:38.356647 | 2025-10-31 19:47:38.356742 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-10-31 19:47:38.985218 | debian-bookworm | changed 2025-10-31 19:47:38.991482 | 2025-10-31 19:47:38.991572 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-10-31 19:47:39.610903 | debian-bookworm | changed 2025-10-31 19:47:39.616148 | 2025-10-31 19:47:39.616231 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-10-31 19:47:39.629657 | debian-bookworm | skipping: Conditional result was False 2025-10-31 19:47:39.637379 | 2025-10-31 19:47:39.637586 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-10-31 19:47:40.050312 | debian-bookworm -> localhost | changed 2025-10-31 19:47:40.060579 | 2025-10-31 19:47:40.060677 | TASK [add-build-sshkey : Add back temp key] 2025-10-31 19:47:40.341215 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/c5c8f6057d26422f92e269019bdf9bfe/work/c5c8f6057d26422f92e269019bdf9bfe_id_rsa (zuul-build-sshkey) 2025-10-31 19:47:40.341426 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.008108 2025-10-31 19:47:40.349089 | 2025-10-31 19:47:40.349187 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-10-31 19:47:40.709481 | debian-bookworm | ok 2025-10-31 19:47:40.714405 | 2025-10-31 19:47:40.714492 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-10-31 19:47:40.737248 | debian-bookworm | skipping: Conditional result was False 2025-10-31 19:47:40.755055 | 2025-10-31 19:47:40.755155 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-10-31 19:47:41.189773 | debian-bookworm | ok 2025-10-31 19:47:41.199840 | 2025-10-31 19:47:41.199936 | TASK [validate-host : Define zuul_info_dir fact] 2025-10-31 19:47:41.227280 | debian-bookworm | ok 2025-10-31 19:47:41.232010 | 2025-10-31 19:47:41.232088 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-10-31 19:47:41.446690 | debian-bookworm -> localhost | ok 2025-10-31 19:47:41.452766 | 2025-10-31 19:47:41.452893 | TASK [validate-host : Collect information about the host] 2025-10-31 19:47:42.562387 | debian-bookworm | ok 2025-10-31 19:47:42.572327 | 2025-10-31 19:47:42.572417 | TASK [validate-host : Sanitize hostname] 2025-10-31 19:47:42.697744 | debian-bookworm | ok 2025-10-31 19:47:42.728523 | 2025-10-31 19:47:42.728614 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-10-31 19:47:43.218979 | debian-bookworm -> localhost | changed 2025-10-31 19:47:43.224250 | 2025-10-31 19:47:43.224342 | TASK [validate-host : Collect information about zuul worker] 2025-10-31 19:47:43.624137 | debian-bookworm | ok 2025-10-31 19:47:43.630548 | 2025-10-31 19:47:43.630654 | TASK [validate-host : Write out all zuul information for each host] 2025-10-31 19:47:44.126846 | debian-bookworm -> localhost | changed 2025-10-31 19:47:44.135642 | 2025-10-31 19:47:44.135732 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-10-31 19:47:44.397145 | debian-bookworm | ok 2025-10-31 19:47:44.402212 | 2025-10-31 19:47:44.402293 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-10-31 19:47:45.209518 | debian-bookworm | changed: 2025-10-31 19:47:45.209688 | debian-bookworm | cd+++++++++ src/ 2025-10-31 19:47:45.209725 | debian-bookworm | cd+++++++++ src/github.com/ 2025-10-31 19:47:45.209751 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-10-31 19:47:45.209774 | debian-bookworm | cd+++++++++ src/github.com/osism/container-image-inventory-reconciler/ 2025-10-31 19:47:45.209795 | debian-bookworm | Containerfile 2025-10-31 19:47:45.210043 | debian-bookworm | localhost | ok: Runtime: 0:00:00.006527 2025-10-31 19:49:23.019903 | 2025-10-31 19:49:23.020022 | TASK [upload-logs : Upload logs to log server] 2025-10-31 19:49:23.555987 | localhost | Output suppressed because no_log was given 2025-10-31 19:49:23.559815 | 2025-10-31 19:49:23.560008 | LOOP [upload-logs : Compress console log and json output] 2025-10-31 19:49:23.614111 | localhost | skipping: Conditional result was False 2025-10-31 19:49:23.618923 | localhost | skipping: Conditional result was False 2025-10-31 19:49:23.630532 | 2025-10-31 19:49:23.630706 | LOOP [upload-logs : Upload compressed console log and json output] 2025-10-31 19:49:23.675030 | localhost | skipping: Conditional result was False 2025-10-31 19:49:23.675606 | 2025-10-31 19:49:23.679064 | localhost | skipping: Conditional result was False 2025-10-31 19:49:23.692220 | 2025-10-31 19:49:23.692445 | LOOP [upload-logs : Upload console log and json output]