2025-09-09 03:01:30.354565 | Job console starting 2025-09-09 03:01:30.362708 | Updating git repos 2025-09-09 03:01:30.955779 | Cloning repos into workspace 2025-09-09 03:01:31.102699 | Restoring repo states 2025-09-09 03:01:31.120775 | Merging changes 2025-09-09 03:01:31.120796 | Checking out repos 2025-09-09 03:01:31.201349 | Preparing playbooks 2025-09-09 03:01:33.238768 | Running Ansible setup 2025-09-09 03:01:39.680615 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-09-09 03:01:40.331877 | 2025-09-09 03:01:40.331992 | PLAY [Base pre] 2025-09-09 03:01:40.361703 | 2025-09-09 03:01:40.361815 | TASK [Setup log path fact] 2025-09-09 03:01:40.399171 | debian-bookworm | ok 2025-09-09 03:01:40.419588 | 2025-09-09 03:01:40.419705 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-09-09 03:01:40.467221 | debian-bookworm | ok 2025-09-09 03:01:40.474939 | 2025-09-09 03:01:40.475025 | TASK [emit-job-header : Print job information] 2025-09-09 03:01:40.525446 | # Job Information 2025-09-09 03:01:40.525579 | Ansible Version: 2.16.14 2025-09-09 03:01:40.525608 | Job: python-black 2025-09-09 03:01:40.525634 | Pipeline: periodic-daily 2025-09-09 03:01:40.525654 | Executor: 521e9411259a 2025-09-09 03:01:40.525671 | Triggered by: https://github.com/osism/openstack-health-middleware 2025-09-09 03:01:40.525689 | Event ID: 8287535cf9254d97a9a0aee75bb43763 2025-09-09 03:01:40.529643 | 2025-09-09 03:01:40.529722 | LOOP [emit-job-header : Print node information] 2025-09-09 03:01:40.624450 | debian-bookworm | ok: 2025-09-09 03:01:40.624593 | debian-bookworm | # Node Information 2025-09-09 03:01:40.624622 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-09-09 03:01:40.624642 | debian-bookworm | Hostname: debian 2025-09-09 03:01:40.624660 | debian-bookworm | Username: zuul 2025-09-09 03:01:40.624677 | debian-bookworm | Distro: Debian 12.12 2025-09-09 03:01:40.624696 | debian-bookworm | Provider: regiocloud-a 2025-09-09 03:01:40.624713 | debian-bookworm | Region: 2025-09-09 03:01:40.624731 | debian-bookworm | Label: debian-bookworm 2025-09-09 03:01:40.624747 | debian-bookworm | Product Name: OpenStack Nova 2025-09-09 03:01:40.624764 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe07:cbc7 2025-09-09 03:01:40.642488 | 2025-09-09 03:01:40.642586 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-09-09 03:01:41.926489 | debian-bookworm -> localhost | changed 2025-09-09 03:01:41.933786 | 2025-09-09 03:01:41.933874 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-09-09 03:01:44.701202 | debian-bookworm -> localhost | changed 2025-09-09 03:01:44.709803 | 2025-09-09 03:01:44.709889 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-09-09 03:01:45.350243 | debian-bookworm -> localhost | ok 2025-09-09 03:01:45.355157 | 2025-09-09 03:01:45.355243 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-09-09 03:01:45.372522 | debian-bookworm | ok 2025-09-09 03:01:45.396062 | debian-bookworm | included: /var/lib/zuul/builds/3b9d9335cae74bbb97fd01bc648f8ead/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-09-09 03:01:45.407947 | 2025-09-09 03:01:45.408032 | TASK [add-build-sshkey : Create Temp SSH key] 2025-09-09 03:01:48.430420 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-09-09 03:01:48.430605 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/3b9d9335cae74bbb97fd01bc648f8ead/work/3b9d9335cae74bbb97fd01bc648f8ead_id_rsa 2025-09-09 03:01:48.430638 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/3b9d9335cae74bbb97fd01bc648f8ead/work/3b9d9335cae74bbb97fd01bc648f8ead_id_rsa.pub 2025-09-09 03:01:48.430660 | debian-bookworm -> localhost | The key fingerprint is: 2025-09-09 03:01:48.430681 | debian-bookworm -> localhost | SHA256:OzsvPAaF8Apl0kYIfC2aHgTn9U/l47UWE5quNp/xEqo zuul-build-sshkey 2025-09-09 03:01:48.430699 | debian-bookworm -> localhost | The key's randomart image is: 2025-09-09 03:01:48.430724 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-09-09 03:01:48.430743 | debian-bookworm -> localhost | |=..++ . . | 2025-09-09 03:01:48.430761 | debian-bookworm -> localhost | | =o+*o o o . | 2025-09-09 03:01:48.430777 | debian-bookworm -> localhost | |. ==.o... = + | 2025-09-09 03:01:48.430794 | debian-bookworm -> localhost | | +. oo.o o + | 2025-09-09 03:01:48.430811 | debian-bookworm -> localhost | |. .. . .S o o | 2025-09-09 03:01:48.430925 | debian-bookworm -> localhost | | . . . o.. | 2025-09-09 03:01:48.430951 | debian-bookworm -> localhost | | o*... | 2025-09-09 03:01:48.430970 | debian-bookworm -> localhost | | .B=.+ | 2025-09-09 03:01:48.430998 | debian-bookworm -> localhost | | Eo.=+.. | 2025-09-09 03:01:48.431015 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-09-09 03:01:48.431058 | debian-bookworm -> localhost | ok: Runtime: 0:00:02.237250 2025-09-09 03:01:48.436982 | 2025-09-09 03:01:48.437060 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-09-09 03:01:48.477734 | debian-bookworm | ok 2025-09-09 03:01:48.491072 | debian-bookworm | included: /var/lib/zuul/builds/3b9d9335cae74bbb97fd01bc648f8ead/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-09-09 03:01:48.519164 | 2025-09-09 03:01:48.519372 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-09-09 03:01:48.562620 | debian-bookworm | skipping: Conditional result was False 2025-09-09 03:01:48.569226 | 2025-09-09 03:01:48.569313 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-09-09 03:01:49.553312 | debian-bookworm | changed 2025-09-09 03:01:49.560383 | 2025-09-09 03:01:49.560482 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-09-09 03:01:49.906553 | debian-bookworm | ok 2025-09-09 03:01:49.912402 | 2025-09-09 03:01:49.912647 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-09-09 03:01:50.654370 | debian-bookworm | changed 2025-09-09 03:01:50.659652 | 2025-09-09 03:01:50.659727 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-09-09 03:01:51.374448 | debian-bookworm | changed 2025-09-09 03:01:51.398691 | 2025-09-09 03:01:51.398783 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-09-09 03:01:51.431496 | debian-bookworm | skipping: Conditional result was False 2025-09-09 03:01:51.436351 | 2025-09-09 03:01:51.436465 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-09-09 03:01:52.173886 | debian-bookworm -> localhost | changed 2025-09-09 03:01:52.182228 | 2025-09-09 03:01:52.182308 | TASK [add-build-sshkey : Add back temp key] 2025-09-09 03:01:52.768225 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/3b9d9335cae74bbb97fd01bc648f8ead/work/3b9d9335cae74bbb97fd01bc648f8ead_id_rsa (zuul-build-sshkey) 2025-09-09 03:01:52.768418 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.041105 2025-09-09 03:01:52.774620 | 2025-09-09 03:01:52.774698 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-09-09 03:01:53.249459 | debian-bookworm | ok 2025-09-09 03:01:53.253437 | 2025-09-09 03:01:53.253511 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-09-09 03:01:53.286120 | debian-bookworm | skipping: Conditional result was False 2025-09-09 03:01:53.295140 | 2025-09-09 03:01:53.295231 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-09-09 03:01:53.878058 | debian-bookworm | ok 2025-09-09 03:01:53.887665 | 2025-09-09 03:01:53.887758 | TASK [validate-host : Define zuul_info_dir fact] 2025-09-09 03:01:53.936644 | debian-bookworm | ok 2025-09-09 03:01:53.941277 | 2025-09-09 03:01:53.941368 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-09-09 03:01:54.424626 | debian-bookworm -> localhost | ok 2025-09-09 03:01:54.437542 | 2025-09-09 03:01:54.438286 | TASK [validate-host : Collect information about the host] 2025-09-09 03:01:55.660581 | debian-bookworm | ok 2025-09-09 03:01:55.699177 | 2025-09-09 03:01:55.699274 | TASK [validate-host : Sanitize hostname] 2025-09-09 03:01:55.966774 | debian-bookworm | ok 2025-09-09 03:01:56.102310 | 2025-09-09 03:01:56.102436 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-09-09 03:01:57.797384 | debian-bookworm -> localhost | changed 2025-09-09 03:01:57.802782 | 2025-09-09 03:01:57.802909 | TASK [validate-host : Collect information about zuul worker] 2025-09-09 03:01:58.566253 | debian-bookworm | ok 2025-09-09 03:01:58.570063 | 2025-09-09 03:01:58.570152 | TASK [validate-host : Write out all zuul information for each host] 2025-09-09 03:02:00.427823 | debian-bookworm -> localhost | changed 2025-09-09 03:02:00.435284 | 2025-09-09 03:02:00.435365 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-09-09 03:02:00.732243 | debian-bookworm | ok 2025-09-09 03:02:00.736653 | 2025-09-09 03:02:00.736728 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-09-09 03:02:02.299373 | debian-bookworm | changed: 2025-09-09 03:02:02.299525 | debian-bookworm | cd+++++++++ src/ 2025-09-09 03:02:02.299553 | debian-bookworm | cd+++++++++ src/github.com/ 2025-09-09 03:02:02.299573 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-09-09 03:02:02.299591 | debian-bookworm | cd+++++++++ src/github.com/osism/openstack-health-middleware/ 2025-09-09 03:02:02.299608 | debian-bookworm | localhost | ok: Runtime: 0:00:00.031944 2025-09-09 03:02:34.473839 | 2025-09-09 03:02:34.473913 | TASK [upload-logs : Upload logs to log server] 2025-09-09 03:02:35.781216 | localhost | Output suppressed because no_log was given 2025-09-09 03:02:35.782598 | 2025-09-09 03:02:35.782670 | LOOP [upload-logs : Compress console log and json output] 2025-09-09 03:02:35.858945 | localhost | skipping: Conditional result was False 2025-09-09 03:02:35.869959 | localhost | skipping: Conditional result was False 2025-09-09 03:02:35.880908 | 2025-09-09 03:02:35.880999 | LOOP [upload-logs : Upload compressed console log and json output] 2025-09-09 03:02:36.082284 | localhost | skipping: Conditional result was False 2025-09-09 03:02:36.082727 | 2025-09-09 03:02:36.120549 | localhost | skipping: Conditional result was False 2025-09-09 03:02:36.125310 | 2025-09-09 03:02:36.125405 | LOOP [upload-logs : Upload console log and json output]