2026-03-06 16:07:23.552238 | Job console starting 2026-03-06 16:07:23.565175 | Updating git repos 2026-03-06 16:07:23.589146 | Cloning repos into workspace 2026-03-06 16:07:23.649444 | Restoring repo states 2026-03-06 16:07:23.656631 | Merging changes 2026-03-06 16:07:24.386701 | Checking out repos 2026-03-06 16:07:24.432757 | Preparing playbooks 2026-03-06 16:07:25.198646 | Running Ansible setup 2026-03-06 16:07:31.501937 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-03-06 16:07:32.395870 | 2026-03-06 16:07:32.396042 | PLAY [Base pre] 2026-03-06 16:07:32.414680 | 2026-03-06 16:07:32.414819 | TASK [Setup log path fact] 2026-03-06 16:07:32.445120 | noble | ok 2026-03-06 16:07:32.462802 | 2026-03-06 16:07:32.462976 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-03-06 16:07:32.522675 | noble | ok 2026-03-06 16:07:32.542682 | 2026-03-06 16:07:32.542822 | TASK [emit-job-header : Print job information] 2026-03-06 16:07:32.584210 | # Job Information 2026-03-06 16:07:32.584391 | Ansible Version: 2.16.14 2026-03-06 16:07:32.584427 | Job: openstack-ironic-images-build-osism-ipa-stable 2026-03-06 16:07:32.584476 | Pipeline: check 2026-03-06 16:07:32.584500 | Executor: 521e9411259a 2026-03-06 16:07:32.584522 | Triggered by: https://github.com/osism/openstack-ironic-images/pull/178 2026-03-06 16:07:32.584546 | Event ID: 2eb8e2e0-1976-11f1-90f5-bc69c2567692 2026-03-06 16:07:32.591712 | 2026-03-06 16:07:32.591831 | LOOP [emit-job-header : Print node information] 2026-03-06 16:07:32.723369 | noble | ok: 2026-03-06 16:07:32.723714 | noble | # Node Information 2026-03-06 16:07:32.723771 | noble | Inventory Hostname: noble 2026-03-06 16:07:32.723812 | noble | Hostname: ubuntu 2026-03-06 16:07:32.723849 | noble | Username: zuul 2026-03-06 16:07:32.723883 | noble | Distro: Ubuntu 24.04 2026-03-06 16:07:32.723922 | noble | Provider: regiocloud-a 2026-03-06 16:07:32.723956 | noble | Region: 2026-03-06 16:07:32.723992 | noble | Label: ubuntu-noble-uefi 2026-03-06 16:07:32.724024 | noble | Product Name: OpenStack Nova 2026-03-06 16:07:32.724057 | noble | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fea0:6d47 2026-03-06 16:07:32.742384 | 2026-03-06 16:07:32.742563 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-03-06 16:07:33.323094 | noble -> localhost | changed 2026-03-06 16:07:33.338591 | 2026-03-06 16:07:33.338747 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-03-06 16:07:34.529724 | noble -> localhost | changed 2026-03-06 16:07:34.555898 | 2026-03-06 16:07:34.556143 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-03-06 16:07:34.992395 | noble -> localhost | ok 2026-03-06 16:07:35.021058 | 2026-03-06 16:07:35.021439 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-03-06 16:07:35.070209 | noble | ok 2026-03-06 16:07:35.104078 | noble | included: /var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-03-06 16:07:35.114238 | 2026-03-06 16:07:35.114403 | TASK [add-build-sshkey : Create Temp SSH key] 2026-03-06 16:07:36.280565 | noble -> localhost | Generating public/private rsa key pair. 2026-03-06 16:07:36.280938 | noble -> localhost | Your identification has been saved in /var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/work/d35122f7f2954e3e8f31644d06efe347_id_rsa 2026-03-06 16:07:36.280983 | noble -> localhost | Your public key has been saved in /var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/work/d35122f7f2954e3e8f31644d06efe347_id_rsa.pub 2026-03-06 16:07:36.281012 | noble -> localhost | The key fingerprint is: 2026-03-06 16:07:36.281037 | noble -> localhost | SHA256:1acdP+HvvD2ocvYZq+N5FAQZk29sMhldXRvQAJsrGI0 zuul-build-sshkey 2026-03-06 16:07:36.281061 | noble -> localhost | The key's randomart image is: 2026-03-06 16:07:36.281082 | noble -> localhost | +---[RSA 3072]----+ 2026-03-06 16:07:36.281103 | noble -> localhost | | =Bo=o+| 2026-03-06 16:07:36.281147 | noble -> localhost | | o =+o .+| 2026-03-06 16:07:36.281169 | noble -> localhost | | E ..oB oo | 2026-03-06 16:07:36.281189 | noble -> localhost | | o. +.X.o.| 2026-03-06 16:07:36.281209 | noble -> localhost | | .S. .* oo.| 2026-03-06 16:07:36.281236 | noble -> localhost | | . . o| 2026-03-06 16:07:36.281257 | noble -> localhost | | ... .| 2026-03-06 16:07:36.281278 | noble -> localhost | | . +.o++.| 2026-03-06 16:07:36.281299 | noble -> localhost | | ==*+ .*| 2026-03-06 16:07:36.281320 | noble -> localhost | +----[SHA256]-----+ 2026-03-06 16:07:36.281404 | noble -> localhost | ok: Runtime: 0:00:00.613085 2026-03-06 16:07:36.298258 | 2026-03-06 16:07:36.298647 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-03-06 16:07:36.335631 | noble | ok 2026-03-06 16:07:36.352963 | noble | included: /var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-03-06 16:07:36.368149 | 2026-03-06 16:07:36.368294 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-03-06 16:07:36.393408 | noble | skipping: Conditional result was False 2026-03-06 16:07:36.413598 | 2026-03-06 16:07:36.413748 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-03-06 16:07:37.088598 | noble | changed 2026-03-06 16:07:37.097531 | 2026-03-06 16:07:37.097660 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-03-06 16:07:37.424166 | noble | ok 2026-03-06 16:07:37.435310 | 2026-03-06 16:07:37.435450 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-03-06 16:07:38.265191 | noble | changed 2026-03-06 16:07:38.282708 | 2026-03-06 16:07:38.283039 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-03-06 16:07:39.090722 | noble | changed 2026-03-06 16:07:39.099387 | 2026-03-06 16:07:39.099528 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-03-06 16:07:39.134229 | noble | skipping: Conditional result was False 2026-03-06 16:07:39.150688 | 2026-03-06 16:07:39.151026 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-03-06 16:07:39.712749 | noble -> localhost | changed 2026-03-06 16:07:39.730429 | 2026-03-06 16:07:39.730613 | TASK [add-build-sshkey : Add back temp key] 2026-03-06 16:07:40.121460 | noble -> localhost | Identity added: /var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/work/d35122f7f2954e3e8f31644d06efe347_id_rsa (zuul-build-sshkey) 2026-03-06 16:07:40.121752 | noble -> localhost | ok: Runtime: 0:00:00.019156 2026-03-06 16:07:40.130120 | 2026-03-06 16:07:40.130248 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-03-06 16:07:40.630529 | noble | ok 2026-03-06 16:07:40.643319 | 2026-03-06 16:07:40.643504 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-03-06 16:07:40.680901 | noble | skipping: Conditional result was False 2026-03-06 16:07:40.767379 | 2026-03-06 16:07:40.767550 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-03-06 16:07:41.237316 | noble | ok 2026-03-06 16:07:41.254629 | 2026-03-06 16:07:41.254793 | TASK [validate-host : Define zuul_info_dir fact] 2026-03-06 16:07:41.316415 | noble | ok 2026-03-06 16:07:41.326992 | 2026-03-06 16:07:41.327176 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-03-06 16:07:41.710796 | noble -> localhost | ok 2026-03-06 16:07:41.723142 | 2026-03-06 16:07:41.723431 | TASK [validate-host : Collect information about the host] 2026-03-06 16:07:43.204457 | noble | ok 2026-03-06 16:07:43.226461 | 2026-03-06 16:07:43.226646 | TASK [validate-host : Sanitize hostname] 2026-03-06 16:07:43.311174 | noble | ok 2026-03-06 16:07:43.320463 | 2026-03-06 16:07:43.320612 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-03-06 16:07:43.979180 | noble -> localhost | changed 2026-03-06 16:07:44.000394 | 2026-03-06 16:07:44.001785 | TASK [validate-host : Collect information about zuul worker] 2026-03-06 16:07:44.513400 | noble | ok 2026-03-06 16:07:44.522224 | 2026-03-06 16:07:44.522390 | TASK [validate-host : Write out all zuul information for each host] 2026-03-06 16:07:45.186432 | noble -> localhost | changed 2026-03-06 16:07:45.202319 | 2026-03-06 16:07:45.202451 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-03-06 16:07:45.523604 | noble | ok 2026-03-06 16:07:45.535897 | 2026-03-06 16:07:45.536037 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-03-06 16:07:46.838222 | noble | changed: 2026-03-06 16:07:46.838719 | noble | cd+++++++++ src/ 2026-03-06 16:07:46.838774 | noble | cd+++++++++ src/github.com/ 2026-03-06 16:07:46.838887 | noble | cd+++++++++ src/github.com/osism/ 2026-03-06 16:07:46.838921 | noble | cd+++++++++ src/github.com/osism/openstack-ironic-images/ 2026-03-06 16:07:46.838952 | noble | localhost | ok: "/var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/work/logs" 2026-03-06 16:13:30.620032 | noble -> localhost | changed: "/var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/work/artifacts" 2026-03-06 16:13:30.894518 | noble -> localhost | changed: "/var/lib/zuul/builds/d35122f7f2954e3e8f31644d06efe347/work/docs" 2026-03-06 16:13:30.908961 | 2026-03-06 16:13:30.909089 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-03-06 16:13:32.218793 | noble | changed: 2026-03-06 16:13:32.219315 | noble | .d..t...... ./ 2026-03-06 16:13:32.219381 | noble | >f+++++++++ osism-ipa-stable.log 2026-03-06 16:13:32.219467 | noble | changed: All items complete 2026-03-06 16:13:32.219516 | 2026-03-06 16:13:32.867084 | noble | changed: .d..t...... ./ 2026-03-06 16:13:33.500227 | noble | changed: .d..t...... ./ 2026-03-06 16:13:33.529398 | 2026-03-06 16:13:33.529601 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-03-06 16:13:34.070386 | noble -> localhost | ok: Item: artifacts Runtime: 0:00:00.009792 2026-03-06 16:13:34.354942 | noble -> localhost | ok: Item: docs Runtime: 0:00:00.008944 2026-03-06 16:13:34.376738 | 2026-03-06 16:13:34.376911 | PLAY RECAP 2026-03-06 16:13:34.376997 | noble | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-03-06 16:13:34.377034 | 2026-03-06 16:13:34.536195 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-03-06 16:13:34.538378 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-03-06 16:13:35.278014 | 2026-03-06 16:13:35.278192 | PLAY [Base post] 2026-03-06 16:13:35.293680 | 2026-03-06 16:13:35.293838 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-03-06 16:13:35.913592 | noble | changed 2026-03-06 16:13:35.920489 | 2026-03-06 16:13:35.920589 | PLAY RECAP 2026-03-06 16:13:35.920686 | noble | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-03-06 16:13:35.920750 | 2026-03-06 16:13:36.048612 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-03-06 16:13:36.049570 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-03-06 16:13:36.860686 | 2026-03-06 16:13:36.860867 | PLAY [Base post-logs] 2026-03-06 16:13:36.871872 | 2026-03-06 16:13:36.872027 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-03-06 16:13:37.355379 | localhost | changed 2026-03-06 16:13:37.366346 | 2026-03-06 16:13:37.366514 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-03-06 16:13:37.406090 | localhost | ok 2026-03-06 16:13:37.411903 | 2026-03-06 16:13:37.412050 | TASK [Set zuul-log-path fact] 2026-03-06 16:13:37.442241 | localhost | ok 2026-03-06 16:13:37.459070 | 2026-03-06 16:13:37.459247 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-03-06 16:13:37.497709 | localhost | ok 2026-03-06 16:13:37.504197 | 2026-03-06 16:13:37.504350 | TASK [upload-logs : Create log directories] 2026-03-06 16:13:38.010526 | localhost | changed 2026-03-06 16:13:38.013464 | 2026-03-06 16:13:38.013578 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-03-06 16:13:38.535327 | localhost -> localhost | ok: Runtime: 0:00:00.006956 2026-03-06 16:13:38.539563 | 2026-03-06 16:13:38.539695 | TASK [upload-logs : Upload logs to log server] 2026-03-06 16:13:39.118521 | localhost | Output suppressed because no_log was given 2026-03-06 16:13:39.124418 | 2026-03-06 16:13:39.125105 | LOOP [upload-logs : Compress console log and json output] 2026-03-06 16:13:39.193303 | localhost | skipping: Conditional result was False 2026-03-06 16:13:39.200473 | localhost | skipping: Conditional result was False 2026-03-06 16:13:39.213514 | 2026-03-06 16:13:39.213797 | LOOP [upload-logs : Upload compressed console log and json output] 2026-03-06 16:13:39.290484 | localhost | skipping: Conditional result was False 2026-03-06 16:13:39.290868 | 2026-03-06 16:13:39.296950 | localhost | skipping: Conditional result was False 2026-03-06 16:13:39.305246 | 2026-03-06 16:13:39.305373 | LOOP [upload-logs : Upload console log and json output]