2026-09-25 02:36:47.932643 | Job console starting 2026-09-25 02:36:47.944531 | Updating git repos 2026-09-25 02:36:47.988500 | Cloning repos into workspace 2026-09-25 02:36:48.022744 | Restoring repo states 2026-09-25 02:36:48.052136 | Merging changes 2026-09-25 02:36:48.795887 | Checking out repos 2026-09-25 02:36:48.860390 | Preparing playbooks 2026-09-25 02:36:50.506085 | Running Ansible setup 2026-09-25 02:36:56.805622 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-09-25 02:36:58.202741 | 2026-09-25 02:36:58.202869 | PLAY [Base pre] 2026-09-25 02:36:58.217405 | 2026-09-25 02:36:58.217504 | TASK [Setup log path fact] 2026-09-25 02:36:58.234416 | debian-bookworm | ok 2026-09-25 02:36:58.255914 | 2026-09-25 02:36:58.256032 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-09-25 02:36:58.309235 | debian-bookworm | ok 2026-09-25 02:36:58.317012 | 2026-09-25 02:36:58.317093 | TASK [emit-job-header : Print job information] 2026-09-25 02:36:58.377505 | # Job Information 2026-09-25 02:36:58.377652 | Ansible Version: 2.16.14 2026-09-25 02:36:58.377681 | Job: container-image-cfg-cookiecutter-build 2026-09-25 02:36:58.377709 | Pipeline: check 2026-09-25 02:36:58.377729 | Executor: 521e9411259a 2026-09-25 02:36:58.377746 | Triggered by: https://github.com/osism/cfg-cookiecutter/pull/878 2026-09-25 02:36:58.377764 | Event ID: bac26b50-b889-11f1-9027-adcebbb3d53e 2026-09-25 02:36:58.385440 | 2026-09-25 02:36:58.385518 | LOOP [emit-job-header : Print node information] 2026-09-25 02:36:58.600811 | debian-bookworm | ok: 2026-09-25 02:36:58.601238 | debian-bookworm | # Node Information 2026-09-25 02:36:58.601974 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-09-25 02:36:58.602019 | debian-bookworm | Hostname: debian 2026-09-25 02:36:58.602042 | debian-bookworm | Username: zuul 2026-09-25 02:36:58.602060 | debian-bookworm | Distro: Debian 12.15 2026-09-25 02:36:58.602082 | debian-bookworm | Provider: regiocloud-a 2026-09-25 02:36:58.602100 | debian-bookworm | Region: 2026-09-25 02:36:58.602118 | debian-bookworm | Label: debian-bookworm 2026-09-25 02:36:58.602134 | debian-bookworm | Product Name: OpenStack Nova 2026-09-25 02:36:58.602150 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe49:69b5 2026-09-25 02:36:58.624974 | 2026-09-25 02:36:58.625258 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-09-25 02:36:59.437721 | debian-bookworm -> localhost | changed 2026-09-25 02:36:59.443516 | 2026-09-25 02:36:59.443805 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-09-25 02:37:01.596829 | debian-bookworm -> localhost | changed 2026-09-25 02:37:01.605361 | 2026-09-25 02:37:01.605448 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-09-25 02:37:02.033902 | debian-bookworm -> localhost | ok 2026-09-25 02:37:02.041807 | 2026-09-25 02:37:02.041897 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-09-25 02:37:02.078414 | debian-bookworm | ok 2026-09-25 02:37:02.105744 | debian-bookworm | included: /var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-09-25 02:37:02.116547 | 2026-09-25 02:37:02.116626 | TASK [add-build-sshkey : Create Temp SSH key] 2026-09-25 02:37:03.873669 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-09-25 02:37:03.873861 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/work/34d0ff4a9d514602b58867a26f1f2c31_id_rsa 2026-09-25 02:37:03.873895 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/work/34d0ff4a9d514602b58867a26f1f2c31_id_rsa.pub 2026-09-25 02:37:03.873918 | debian-bookworm -> localhost | The key fingerprint is: 2026-09-25 02:37:03.873940 | debian-bookworm -> localhost | SHA256:t+gyR52keSPetpxT+izMyWjh5kiXN1if1fdV3Kx0XwU zuul-build-sshkey 2026-09-25 02:37:03.873970 | debian-bookworm -> localhost | The key's randomart image is: 2026-09-25 02:37:03.873989 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-09-25 02:37:03.874008 | debian-bookworm -> localhost | | E..| 2026-09-25 02:37:03.874026 | debian-bookworm -> localhost | | oo| 2026-09-25 02:37:03.874043 | debian-bookworm -> localhost | | . B| 2026-09-25 02:37:03.874059 | debian-bookworm -> localhost | | . . ++| 2026-09-25 02:37:03.874076 | debian-bookworm -> localhost | | S=o. o =| 2026-09-25 02:37:03.874095 | debian-bookworm -> localhost | | **=o.o +| 2026-09-25 02:37:03.874112 | debian-bookworm -> localhost | | .+=X+=o .| 2026-09-25 02:37:03.874128 | debian-bookworm -> localhost | | .o+Bo@+ | 2026-09-25 02:37:03.874145 | debian-bookworm -> localhost | | .Bo.+=o | 2026-09-25 02:37:03.874162 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-09-25 02:37:03.874205 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.141259 2026-09-25 02:37:03.879873 | 2026-09-25 02:37:03.879950 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-09-25 02:37:03.906793 | debian-bookworm | ok 2026-09-25 02:37:03.920978 | debian-bookworm | included: /var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-09-25 02:37:03.946093 | 2026-09-25 02:37:03.946185 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-09-25 02:37:03.968933 | debian-bookworm | skipping: Conditional result was False 2026-09-25 02:37:03.973646 | 2026-09-25 02:37:03.973725 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-09-25 02:37:04.683267 | debian-bookworm | changed 2026-09-25 02:37:04.688732 | 2026-09-25 02:37:04.688831 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-09-25 02:37:04.960758 | debian-bookworm | ok 2026-09-25 02:37:04.968098 | 2026-09-25 02:37:04.968230 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-09-25 02:37:05.726915 | debian-bookworm | changed 2026-09-25 02:37:05.733518 | 2026-09-25 02:37:05.733689 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-09-25 02:37:06.421127 | debian-bookworm | changed 2026-09-25 02:37:06.426471 | 2026-09-25 02:37:06.426565 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-09-25 02:37:06.441364 | debian-bookworm | skipping: Conditional result was False 2026-09-25 02:37:06.454322 | 2026-09-25 02:37:06.454452 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-09-25 02:37:06.996912 | debian-bookworm -> localhost | changed 2026-09-25 02:37:07.007293 | 2026-09-25 02:37:07.007389 | TASK [add-build-sshkey : Add back temp key] 2026-09-25 02:37:07.396871 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/work/34d0ff4a9d514602b58867a26f1f2c31_id_rsa (zuul-build-sshkey) 2026-09-25 02:37:07.397078 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.029318 2026-09-25 02:37:07.404247 | 2026-09-25 02:37:07.404340 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-09-25 02:37:08.042327 | debian-bookworm | ok 2026-09-25 02:37:08.047884 | 2026-09-25 02:37:08.047980 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-09-25 02:37:08.133283 | debian-bookworm | skipping: Conditional result was False 2026-09-25 02:37:08.142983 | 2026-09-25 02:37:08.143075 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-09-25 02:37:09.061479 | debian-bookworm | ok 2026-09-25 02:37:09.075162 | 2026-09-25 02:37:09.075252 | TASK [validate-host : Define zuul_info_dir fact] 2026-09-25 02:37:09.125818 | debian-bookworm | ok 2026-09-25 02:37:09.130423 | 2026-09-25 02:37:09.130503 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-09-25 02:37:10.044559 | debian-bookworm -> localhost | ok 2026-09-25 02:37:10.056156 | 2026-09-25 02:37:10.056269 | TASK [validate-host : Collect information about the host] 2026-09-25 02:37:12.304007 | debian-bookworm | ok 2026-09-25 02:37:12.315498 | 2026-09-25 02:37:12.315585 | TASK [validate-host : Sanitize hostname] 2026-09-25 02:37:12.516495 | debian-bookworm | ok 2026-09-25 02:37:12.528982 | 2026-09-25 02:37:12.529071 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-09-25 02:37:13.445015 | debian-bookworm -> localhost | changed 2026-09-25 02:37:13.449533 | 2026-09-25 02:37:13.449638 | TASK [validate-host : Collect information about zuul worker] 2026-09-25 02:37:13.890447 | debian-bookworm | ok 2026-09-25 02:37:13.894208 | 2026-09-25 02:37:13.894292 | TASK [validate-host : Write out all zuul information for each host] 2026-09-25 02:37:14.730735 | debian-bookworm -> localhost | changed 2026-09-25 02:37:14.738567 | 2026-09-25 02:37:14.738654 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-09-25 02:37:15.074824 | debian-bookworm | ok 2026-09-25 02:37:15.079248 | 2026-09-25 02:37:15.079325 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-09-25 02:37:16.198013 | debian-bookworm | changed: 2026-09-25 02:37:16.198371 | debian-bookworm | cd+++++++++ src/ 2026-09-25 02:37:16.198411 | debian-bookworm | cd+++++++++ src/github.com/ 2026-09-25 02:37:16.198442 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-09-25 02:37:16.198463 | debian-bookworm | cd+++++++++ src/github.com/osism/cfg-cookiecutter/ 2026-09-25 02:37:16.198480 | debian-bookworm | Containerfile 2026-09-25 02:37:16.198590 | debian-bookworm | localhost | ok: "/var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/work/logs" 2026-09-25 02:39:44.527045 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/work/artifacts" 2026-09-25 02:39:44.793352 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/34d0ff4a9d514602b58867a26f1f2c31/work/docs" 2026-09-25 02:39:44.820121 | 2026-09-25 02:39:44.820272 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-09-25 02:39:45.543629 | debian-bookworm | changed: 2026-09-25 02:39:45.543893 | debian-bookworm | .d..t...... ./ 2026-09-25 02:39:45.543937 | debian-bookworm | >f+++++++++ net-debug.post.txt 2026-09-25 02:39:45.543965 | debian-bookworm | >f+++++++++ net-debug.pre.txt 2026-09-25 02:39:45.543991 | debian-bookworm | >f+++++++++ sudo-debug.txt 2026-09-25 02:39:45.544017 | debian-bookworm | >f+++++++++ sudo-strace.log 2026-09-25 02:39:45.544040 | debian-bookworm | >f+++++++++ sudo-strace.log.time 2026-09-25 02:39:45.544082 | debian-bookworm | changed: All items complete 2026-09-25 02:39:45.544112 | 2026-09-25 02:39:46.072800 | debian-bookworm | changed: .d..t...... ./ 2026-09-25 02:39:46.634332 | debian-bookworm | changed: .d..t...... ./ 2026-09-25 02:39:46.649750 | 2026-09-25 02:39:46.649967 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-09-25 02:39:46.993850 | debian-bookworm -> localhost | ok: Item: artifacts Runtime: 0:00:00.005319 2026-09-25 02:39:47.284189 | debian-bookworm -> localhost | ok: Item: docs Runtime: 0:00:00.006161 2026-09-25 02:39:47.307629 | 2026-09-25 02:39:47.307783 | PLAY RECAP 2026-09-25 02:39:47.307847 | debian-bookworm | ok: 8 changed: 3 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-09-25 02:39:47.307873 | 2026-09-25 02:39:47.451597 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-09-25 02:39:47.452568 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-09-25 02:39:48.215640 | 2026-09-25 02:39:48.215867 | PLAY [Base post] 2026-09-25 02:39:48.232692 | 2026-09-25 02:39:48.232835 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-09-25 02:39:49.104135 | debian-bookworm | changed 2026-09-25 02:39:49.118479 | 2026-09-25 02:39:49.118623 | PLAY RECAP 2026-09-25 02:39:49.118712 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-09-25 02:39:49.118801 | 2026-09-25 02:39:49.236101 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-09-25 02:39:49.238440 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-09-25 02:39:50.002278 | 2026-09-25 02:39:50.002459 | PLAY [Base post-logs] 2026-09-25 02:39:50.012948 | 2026-09-25 02:39:50.013082 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-09-25 02:39:50.467531 | localhost | changed 2026-09-25 02:39:50.477626 | 2026-09-25 02:39:50.477764 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-09-25 02:39:50.514189 | localhost | ok 2026-09-25 02:39:50.519641 | 2026-09-25 02:39:50.519799 | TASK [Set zuul-log-path fact] 2026-09-25 02:39:50.536203 | localhost | ok 2026-09-25 02:39:50.546786 | 2026-09-25 02:39:50.546908 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-09-25 02:39:50.572804 | localhost | ok 2026-09-25 02:39:50.578162 | 2026-09-25 02:39:50.578361 | TASK [upload-logs : Create log directories] 2026-09-25 02:39:51.119061 | localhost | changed 2026-09-25 02:39:51.123819 | 2026-09-25 02:39:51.123970 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-09-25 02:39:51.614079 | localhost -> localhost | ok: Runtime: 0:00:00.006736 2026-09-25 02:39:51.618463 | 2026-09-25 02:39:51.618583 | TASK [upload-logs : Upload logs to log server] 2026-09-25 02:39:52.173366 | localhost | Output suppressed because no_log was given 2026-09-25 02:39:52.177655 | 2026-09-25 02:39:52.177866 | LOOP [upload-logs : Compress console log and json output] 2026-09-25 02:39:52.236924 | localhost | skipping: Conditional result was False 2026-09-25 02:39:52.242112 | localhost | skipping: Conditional result was False 2026-09-25 02:39:52.248970 | 2026-09-25 02:39:52.249144 | LOOP [upload-logs : Upload compressed console log and json output] 2026-09-25 02:39:52.294556 | localhost | skipping: Conditional result was False 2026-09-25 02:39:52.295074 | 2026-09-25 02:39:52.299050 | localhost | skipping: Conditional result was False 2026-09-25 02:39:52.310996 | 2026-09-25 02:39:52.311201 | LOOP [upload-logs : Upload console log and json output]