2026-07-02 14:14:11.519899 | Job console starting 2026-07-02 14:14:11.530651 | Updating git repos 2026-07-02 14:14:11.603814 | Cloning repos into workspace 2026-07-02 14:14:11.708642 | Restoring repo states 2026-07-02 14:14:11.734411 | Merging changes 2026-07-02 14:14:12.546633 | Checking out repos 2026-07-02 14:14:12.648426 | Preparing playbooks 2026-07-02 14:14:14.061130 | Running Ansible setup 2026-07-02 14:14:20.818183 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2026-07-02 14:14:21.664574 | 2026-07-02 14:14:21.664699 | PLAY [Base pre] 2026-07-02 14:14:21.678828 | 2026-07-02 14:14:21.678954 | TASK [Setup log path fact] 2026-07-02 14:14:21.695449 | debian-bookworm | ok 2026-07-02 14:14:21.707860 | 2026-07-02 14:14:21.707966 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-07-02 14:14:21.734309 | debian-bookworm | ok 2026-07-02 14:14:21.742037 | 2026-07-02 14:14:21.742127 | TASK [emit-job-header : Print job information] 2026-07-02 14:14:21.789319 | # Job Information 2026-07-02 14:14:21.789463 | Ansible Version: 2.16.14 2026-07-02 14:14:21.789490 | Job: python-black 2026-07-02 14:14:21.789516 | Pipeline: check 2026-07-02 14:14:21.789535 | Executor: 521e9411259a 2026-07-02 14:14:21.789551 | Triggered by: https://github.com/osism/python-osism/pull/2342 2026-07-02 14:14:21.789569 | Event ID: 451dadc0-7620-11f1-8be3-9335493d05a9 2026-07-02 14:14:21.793489 | 2026-07-02 14:14:21.793574 | LOOP [emit-job-header : Print node information] 2026-07-02 14:14:22.035253 | debian-bookworm | ok: 2026-07-02 14:14:22.035451 | debian-bookworm | # Node Information 2026-07-02 14:14:22.035522 | debian-bookworm | Inventory Hostname: debian-bookworm 2026-07-02 14:14:22.035550 | debian-bookworm | Hostname: debian 2026-07-02 14:14:22.035572 | debian-bookworm | Username: zuul 2026-07-02 14:14:22.035592 | debian-bookworm | Distro: Debian 12.14 2026-07-02 14:14:22.035617 | debian-bookworm | Provider: regiocloud-a 2026-07-02 14:14:22.035638 | debian-bookworm | Region: 2026-07-02 14:14:22.035659 | debian-bookworm | Label: debian-bookworm 2026-07-02 14:14:22.035689 | debian-bookworm | Product Name: OpenStack Nova 2026-07-02 14:14:22.035709 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe71:fc2a 2026-07-02 14:14:22.054563 | 2026-07-02 14:14:22.054706 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-07-02 14:14:23.064766 | debian-bookworm -> localhost | changed 2026-07-02 14:14:23.070541 | 2026-07-02 14:14:23.070639 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-07-02 14:14:25.212469 | debian-bookworm -> localhost | changed 2026-07-02 14:14:25.220986 | 2026-07-02 14:14:25.221075 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-07-02 14:14:25.879466 | debian-bookworm -> localhost | ok 2026-07-02 14:14:25.884541 | 2026-07-02 14:14:25.884632 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-07-02 14:14:25.922504 | debian-bookworm | ok 2026-07-02 14:14:25.942394 | debian-bookworm | included: /var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-07-02 14:14:25.964650 | 2026-07-02 14:14:25.964782 | TASK [add-build-sshkey : Create Temp SSH key] 2026-07-02 14:14:27.673947 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2026-07-02 14:14:27.674110 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/work/5571d8ab53344caa9387934443f9b2d8_id_rsa 2026-07-02 14:14:27.674140 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/work/5571d8ab53344caa9387934443f9b2d8_id_rsa.pub 2026-07-02 14:14:27.674162 | debian-bookworm -> localhost | The key fingerprint is: 2026-07-02 14:14:27.674182 | debian-bookworm -> localhost | SHA256:x/7lbmwTJqa1kuApfBVfbxoKoUgBlMGmiOE+Ec/q28g zuul-build-sshkey 2026-07-02 14:14:27.674201 | debian-bookworm -> localhost | The key's randomart image is: 2026-07-02 14:14:27.674225 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2026-07-02 14:14:27.674243 | debian-bookworm -> localhost | | o++ | 2026-07-02 14:14:27.674260 | debian-bookworm -> localhost | |.. + . | 2026-07-02 14:14:27.674277 | debian-bookworm -> localhost | |oo+o . | 2026-07-02 14:14:27.674293 | debian-bookworm -> localhost | |oo.o . .o . | 2026-07-02 14:14:27.674309 | debian-bookworm -> localhost | |. o . .S.o+ . . | 2026-07-02 14:14:27.674327 | debian-bookworm -> localhost | | + . ooo = + o| 2026-07-02 14:14:27.674344 | debian-bookworm -> localhost | |. . . . +.* *.= | 2026-07-02 14:14:27.674359 | debian-bookworm -> localhost | |..o o + +.oo* | 2026-07-02 14:14:27.674376 | debian-bookworm -> localhost | | E.. o ..+o. | 2026-07-02 14:14:27.674392 | debian-bookworm -> localhost | +----[SHA256]-----+ 2026-07-02 14:14:27.674433 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.574954 2026-07-02 14:14:27.679607 | 2026-07-02 14:14:27.679718 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-07-02 14:14:27.726427 | debian-bookworm | ok 2026-07-02 14:14:27.734460 | debian-bookworm | included: /var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-07-02 14:14:27.751180 | 2026-07-02 14:14:27.751271 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-07-02 14:14:27.784061 | debian-bookworm | skipping: Conditional result was False 2026-07-02 14:14:27.789148 | 2026-07-02 14:14:27.789242 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-07-02 14:14:28.732652 | debian-bookworm | changed 2026-07-02 14:14:28.736965 | 2026-07-02 14:14:28.737038 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-07-02 14:14:29.035335 | debian-bookworm | ok 2026-07-02 14:14:29.039730 | 2026-07-02 14:14:29.039807 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-07-02 14:14:29.875197 | debian-bookworm | changed 2026-07-02 14:14:29.879635 | 2026-07-02 14:14:29.879733 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-07-02 14:14:30.589940 | debian-bookworm | changed 2026-07-02 14:14:30.594749 | 2026-07-02 14:14:30.594850 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-07-02 14:14:30.617960 | debian-bookworm | skipping: Conditional result was False 2026-07-02 14:14:30.622819 | 2026-07-02 14:14:30.623042 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-07-02 14:14:31.009355 | debian-bookworm -> localhost | changed 2026-07-02 14:14:31.017980 | 2026-07-02 14:14:31.018072 | TASK [add-build-sshkey : Add back temp key] 2026-07-02 14:14:31.327279 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/work/5571d8ab53344caa9387934443f9b2d8_id_rsa (zuul-build-sshkey) 2026-07-02 14:14:31.327466 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.008147 2026-07-02 14:14:31.335642 | 2026-07-02 14:14:31.335747 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-07-02 14:14:31.689984 | debian-bookworm | ok 2026-07-02 14:14:31.695975 | 2026-07-02 14:14:31.696075 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-07-02 14:14:31.719120 | debian-bookworm | skipping: Conditional result was False 2026-07-02 14:14:31.730083 | 2026-07-02 14:14:31.730181 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-07-02 14:14:32.227263 | debian-bookworm | ok 2026-07-02 14:14:32.249092 | 2026-07-02 14:14:32.249215 | TASK [validate-host : Define zuul_info_dir fact] 2026-07-02 14:14:32.278415 | debian-bookworm | ok 2026-07-02 14:14:32.283589 | 2026-07-02 14:14:32.283696 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-07-02 14:14:32.658025 | debian-bookworm -> localhost | ok 2026-07-02 14:14:32.664180 | 2026-07-02 14:14:32.664328 | TASK [validate-host : Collect information about the host] 2026-07-02 14:14:33.820287 | debian-bookworm | ok 2026-07-02 14:14:33.842975 | 2026-07-02 14:14:33.843125 | TASK [validate-host : Sanitize hostname] 2026-07-02 14:14:34.080667 | debian-bookworm | ok 2026-07-02 14:14:34.085078 | 2026-07-02 14:14:34.085174 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-07-02 14:14:34.804990 | debian-bookworm -> localhost | changed 2026-07-02 14:14:34.815127 | 2026-07-02 14:14:34.815246 | TASK [validate-host : Collect information about zuul worker] 2026-07-02 14:14:35.239865 | debian-bookworm | ok 2026-07-02 14:14:35.245308 | 2026-07-02 14:14:35.245416 | TASK [validate-host : Write out all zuul information for each host] 2026-07-02 14:14:36.184831 | debian-bookworm -> localhost | changed 2026-07-02 14:14:36.197530 | 2026-07-02 14:14:36.197651 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2026-07-02 14:14:36.484056 | debian-bookworm | ok 2026-07-02 14:14:36.489733 | 2026-07-02 14:14:36.489843 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2026-07-02 14:14:37.784925 | debian-bookworm | changed: 2026-07-02 14:14:37.785101 | debian-bookworm | cd+++++++++ src/ 2026-07-02 14:14:37.785135 | debian-bookworm | cd+++++++++ src/github.com/ 2026-07-02 14:14:37.785160 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2026-07-02 14:14:37.785181 | debian-bookworm | cd+++++++++ src/github.com/osism/python-osism/ 2026-07-02 14:14:37.785201 | debian-bookworm | Containerfile 2026-07-02 14:14:37.785329 | debian-bookworm | Containerfile 2026-07-02 14:14:37.834657 | debian-bookworm | localhost | ok: "/var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/work/logs" 2026-07-02 14:15:45.867205 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/work/artifacts" 2026-07-02 14:15:46.141931 | debian-bookworm -> localhost | changed: "/var/lib/zuul/builds/5571d8ab53344caa9387934443f9b2d8/work/docs" 2026-07-02 14:15:46.152791 | 2026-07-02 14:15:46.152925 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-07-02 14:15:46.993312 | debian-bookworm | changed: 2026-07-02 14:15:46.993639 | debian-bookworm | .d..t...... ./ 2026-07-02 14:15:46.993698 | debian-bookworm | >f+++++++++ net-debug.post.txt 2026-07-02 14:15:46.993870 | debian-bookworm | >f+++++++++ net-debug.pre.txt 2026-07-02 14:15:46.993905 | debian-bookworm | >f+++++++++ sudo-debug.txt 2026-07-02 14:15:46.993932 | debian-bookworm | >f+++++++++ sudo-strace.log 2026-07-02 14:15:46.993958 | debian-bookworm | >f+++++++++ sudo-strace.log.time 2026-07-02 14:15:46.994070 | debian-bookworm | changed: All items complete 2026-07-02 14:15:46.994112 | 2026-07-02 14:15:47.586373 | debian-bookworm | changed: .d..t...... ./ 2026-07-02 14:15:48.181607 | debian-bookworm | changed: .d..t...... ./ 2026-07-02 14:15:48.199633 | 2026-07-02 14:15:48.199779 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-07-02 14:15:48.548974 | debian-bookworm -> localhost | ok: Item: artifacts Runtime: 0:00:00.010222 2026-07-02 14:15:48.862224 | debian-bookworm -> localhost | ok: Item: docs Runtime: 0:00:00.010911 2026-07-02 14:15:48.872702 | 2026-07-02 14:15:48.872953 | PLAY RECAP 2026-07-02 14:15:48.873091 | debian-bookworm | ok: 8 changed: 3 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-07-02 14:15:48.873164 | 2026-07-02 14:15:49.016043 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post-fetch.yaml@main] 2026-07-02 14:15:49.017218 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-07-02 14:15:49.779032 | 2026-07-02 14:15:49.779222 | PLAY [Base post] 2026-07-02 14:15:49.796979 | 2026-07-02 14:15:49.797157 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-07-02 14:15:50.451733 | debian-bookworm | changed 2026-07-02 14:15:50.463671 | 2026-07-02 14:15:50.463890 | PLAY RECAP 2026-07-02 14:15:50.463982 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-07-02 14:15:50.464076 | 2026-07-02 14:15:50.592282 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2026-07-02 14:15:50.593181 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2026-07-02 14:15:51.430181 | 2026-07-02 14:15:51.430449 | PLAY [Base post-logs] 2026-07-02 14:15:51.446989 | 2026-07-02 14:15:51.447215 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-07-02 14:15:51.923523 | localhost | changed 2026-07-02 14:15:51.940433 | 2026-07-02 14:15:51.940626 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-07-02 14:15:51.980063 | localhost | ok 2026-07-02 14:15:51.987126 | 2026-07-02 14:15:51.987508 | TASK [Set zuul-log-path fact] 2026-07-02 14:15:52.008049 | localhost | ok 2026-07-02 14:15:52.029731 | 2026-07-02 14:15:52.029948 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-07-02 14:15:52.060214 | localhost | ok 2026-07-02 14:15:52.068052 | 2026-07-02 14:15:52.068275 | TASK [upload-logs : Create log directories] 2026-07-02 14:15:52.619885 | localhost | changed 2026-07-02 14:15:52.625766 | 2026-07-02 14:15:52.625886 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-07-02 14:15:53.121412 | localhost -> localhost | ok: Runtime: 0:00:00.007389 2026-07-02 14:15:53.130169 | 2026-07-02 14:15:53.130354 | TASK [upload-logs : Upload logs to log server] 2026-07-02 14:15:53.774041 | localhost | Output suppressed because no_log was given 2026-07-02 14:15:53.778550 | 2026-07-02 14:15:53.778761 | LOOP [upload-logs : Compress console log and json output] 2026-07-02 14:15:53.837058 | localhost | skipping: Conditional result was False 2026-07-02 14:15:53.841875 | localhost | skipping: Conditional result was False 2026-07-02 14:15:53.853786 | 2026-07-02 14:15:53.853987 | LOOP [upload-logs : Upload compressed console log and json output] 2026-07-02 14:15:53.914677 | localhost | skipping: Conditional result was False 2026-07-02 14:15:53.915396 | 2026-07-02 14:15:53.918660 | localhost | skipping: Conditional result was False 2026-07-02 14:15:53.924774 | 2026-07-02 14:15:53.925050 | LOOP [upload-logs : Upload console log and json output]