2025-09-28 03:01:59.704160 | Job console starting 2025-09-28 03:01:59.711844 | Updating git repos 2025-09-28 03:01:59.779893 | Cloning repos into workspace 2025-09-28 03:01:59.891824 | Restoring repo states 2025-09-28 03:01:59.936532 | Merging changes 2025-09-28 03:01:59.936548 | Checking out repos 2025-09-28 03:02:00.094182 | Preparing playbooks 2025-09-28 03:02:01.439141 | Running Ansible setup 2025-09-28 03:02:09.872524 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-09-28 03:02:11.316163 | 2025-09-28 03:02:11.316276 | PLAY [Base pre] 2025-09-28 03:02:11.354267 | 2025-09-28 03:02:11.354374 | TASK [Setup log path fact] 2025-09-28 03:02:11.385018 | debian-bookworm | ok 2025-09-28 03:02:11.430450 | 2025-09-28 03:02:11.430575 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-09-28 03:02:11.485114 | debian-bookworm | ok 2025-09-28 03:02:11.499201 | 2025-09-28 03:02:11.499294 | TASK [emit-job-header : Print job information] 2025-09-28 03:02:11.553669 | # Job Information 2025-09-28 03:02:11.554120 | Ansible Version: 2.16.14 2025-09-28 03:02:11.554172 | Job: python-black 2025-09-28 03:02:11.554338 | Pipeline: periodic-daily 2025-09-28 03:02:11.554361 | Executor: 521e9411259a 2025-09-28 03:02:11.554388 | Triggered by: https://github.com/osism/container-image-kolla-ansible 2025-09-28 03:02:11.554533 | Event ID: 7158885475db429b97606ba7c74fe677 2025-09-28 03:02:11.562751 | 2025-09-28 03:02:11.563379 | LOOP [emit-job-header : Print node information] 2025-09-28 03:02:11.666103 | debian-bookworm | ok: 2025-09-28 03:02:11.666241 | debian-bookworm | # Node Information 2025-09-28 03:02:11.666269 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-09-28 03:02:11.666289 | debian-bookworm | Hostname: debian 2025-09-28 03:02:11.666307 | debian-bookworm | Username: zuul 2025-09-28 03:02:11.666325 | debian-bookworm | Distro: Debian 12.12 2025-09-28 03:02:11.666344 | debian-bookworm | Provider: regiocloud-a 2025-09-28 03:02:11.666361 | debian-bookworm | Region: 2025-09-28 03:02:11.666378 | debian-bookworm | Label: debian-bookworm 2025-09-28 03:02:11.666395 | debian-bookworm | Product Name: OpenStack Nova 2025-09-28 03:02:11.666411 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:feb5:90a8 2025-09-28 03:02:11.676788 | 2025-09-28 03:02:11.676885 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-09-28 03:02:12.104177 | debian-bookworm -> localhost | changed 2025-09-28 03:02:12.109782 | 2025-09-28 03:02:12.109869 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-09-28 03:02:13.355371 | debian-bookworm -> localhost | changed 2025-09-28 03:02:13.363805 | 2025-09-28 03:02:13.363882 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-09-28 03:02:13.581279 | debian-bookworm -> localhost | ok 2025-09-28 03:02:13.588258 | 2025-09-28 03:02:13.588372 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-09-28 03:02:13.609606 | debian-bookworm | ok 2025-09-28 03:02:13.630316 | debian-bookworm | included: /var/lib/zuul/builds/1a63b75fff7f4d87874e61edc9f105f7/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-09-28 03:02:13.637812 | 2025-09-28 03:02:13.638010 | TASK [add-build-sshkey : Create Temp SSH key] 2025-09-28 03:02:15.214778 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-09-28 03:02:15.214987 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/1a63b75fff7f4d87874e61edc9f105f7/work/1a63b75fff7f4d87874e61edc9f105f7_id_rsa 2025-09-28 03:02:15.215026 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/1a63b75fff7f4d87874e61edc9f105f7/work/1a63b75fff7f4d87874e61edc9f105f7_id_rsa.pub 2025-09-28 03:02:15.215054 | debian-bookworm -> localhost | The key fingerprint is: 2025-09-28 03:02:15.215079 | debian-bookworm -> localhost | SHA256:FjCLBbLZ9zKC1lZEUH68e7819AnZhSDm0i8EwPuXnAg zuul-build-sshkey 2025-09-28 03:02:15.215102 | debian-bookworm -> localhost | The key's randomart image is: 2025-09-28 03:02:15.215135 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-09-28 03:02:15.215157 | debian-bookworm -> localhost | | . o*O.. o . | 2025-09-28 03:02:15.215179 | debian-bookworm -> localhost | | = =.= = . . . | 2025-09-28 03:02:15.215199 | debian-bookworm -> localhost | | o o =.= + . .| 2025-09-28 03:02:15.215219 | debian-bookworm -> localhost | | o oEo = . o .| 2025-09-28 03:02:15.215239 | debian-bookworm -> localhost | | o + ooSo.o.o.. | 2025-09-28 03:02:15.215264 | debian-bookworm -> localhost | | . . . +o.=. ....| 2025-09-28 03:02:15.215285 | debian-bookworm -> localhost | | ... o..| 2025-09-28 03:02:15.215306 | debian-bookworm -> localhost | | . . . . | 2025-09-28 03:02:15.215327 | debian-bookworm -> localhost | | o. | 2025-09-28 03:02:15.215348 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-09-28 03:02:15.215401 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.927009 2025-09-28 03:02:15.221530 | 2025-09-28 03:02:15.221624 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-09-28 03:02:15.252455 | debian-bookworm | ok 2025-09-28 03:02:15.263468 | debian-bookworm | included: /var/lib/zuul/builds/1a63b75fff7f4d87874e61edc9f105f7/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-09-28 03:02:15.287723 | 2025-09-28 03:02:15.287841 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-09-28 03:02:15.300897 | debian-bookworm | skipping: Conditional result was False 2025-09-28 03:02:15.307325 | 2025-09-28 03:02:15.307421 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-09-28 03:02:15.919042 | debian-bookworm | changed 2025-09-28 03:02:15.925724 | 2025-09-28 03:02:15.925813 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-09-28 03:02:16.187618 | debian-bookworm | ok 2025-09-28 03:02:16.193176 | 2025-09-28 03:02:16.193258 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-09-28 03:02:16.831466 | debian-bookworm | changed 2025-09-28 03:02:16.837724 | 2025-09-28 03:02:16.837823 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-09-28 03:02:17.509649 | debian-bookworm | changed 2025-09-28 03:02:17.514794 | 2025-09-28 03:02:17.514895 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-09-28 03:02:17.527677 | debian-bookworm | skipping: Conditional result was False 2025-09-28 03:02:17.534016 | 2025-09-28 03:02:17.534120 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-09-28 03:02:17.935385 | debian-bookworm -> localhost | changed 2025-09-28 03:02:17.950886 | 2025-09-28 03:02:17.950997 | TASK [add-build-sshkey : Add back temp key] 2025-09-28 03:02:18.407036 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/1a63b75fff7f4d87874e61edc9f105f7/work/1a63b75fff7f4d87874e61edc9f105f7_id_rsa (zuul-build-sshkey) 2025-09-28 03:02:18.407237 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.009706 2025-09-28 03:02:18.414658 | 2025-09-28 03:02:18.414758 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-09-28 03:02:18.804273 | debian-bookworm | ok 2025-09-28 03:02:18.808524 | 2025-09-28 03:02:18.808596 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-09-28 03:02:18.833998 | debian-bookworm | skipping: Conditional result was False 2025-09-28 03:02:18.854960 | 2025-09-28 03:02:18.855040 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-09-28 03:02:19.282087 | debian-bookworm | ok 2025-09-28 03:02:19.305862 | 2025-09-28 03:02:19.306015 | TASK [validate-host : Define zuul_info_dir fact] 2025-09-28 03:02:19.336604 | debian-bookworm | ok 2025-09-28 03:02:19.342599 | 2025-09-28 03:02:19.342690 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-09-28 03:02:19.639525 | debian-bookworm -> localhost | ok 2025-09-28 03:02:19.645905 | 2025-09-28 03:02:19.645993 | TASK [validate-host : Collect information about the host] 2025-09-28 03:02:20.947375 | debian-bookworm | ok 2025-09-28 03:02:20.980348 | 2025-09-28 03:02:20.980456 | TASK [validate-host : Sanitize hostname] 2025-09-28 03:02:21.121583 | debian-bookworm | ok 2025-09-28 03:02:21.192025 | 2025-09-28 03:02:21.192135 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-09-28 03:02:22.031634 | debian-bookworm -> localhost | changed 2025-09-28 03:02:22.044627 | 2025-09-28 03:02:22.044788 | TASK [validate-host : Collect information about zuul worker] 2025-09-28 03:02:22.426854 | debian-bookworm | ok 2025-09-28 03:02:22.431268 | 2025-09-28 03:02:22.431354 | TASK [validate-host : Write out all zuul information for each host] 2025-09-28 03:02:22.951014 | debian-bookworm -> localhost | changed 2025-09-28 03:02:22.959694 | 2025-09-28 03:02:22.959807 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-09-28 03:02:23.239822 | debian-bookworm | ok 2025-09-28 03:02:23.245023 | 2025-09-28 03:02:23.245110 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-09-28 03:02:24.136515 | debian-bookworm | changed: 2025-09-28 03:02:24.136680 | debian-bookworm | cd+++++++++ src/ 2025-09-28 03:02:24.136715 | debian-bookworm | cd+++++++++ src/github.com/ 2025-09-28 03:02:24.136772 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-09-28 03:02:24.136796 | debian-bookworm | cd+++++++++ src/github.com/osism/container-image-kolla-ansible/ 2025-09-28 03:02:24.136817 | debian-bookworm | Containerfile 2025-09-28 03:02:24.136954 | debian-bookworm | localhost | ok: Runtime: 0:00:00.027483 2025-09-28 03:02:49.242700 | 2025-09-28 03:02:49.242856 | TASK [upload-logs : Upload logs to log server] 2025-09-28 03:02:49.766316 | localhost | Output suppressed because no_log was given 2025-09-28 03:02:49.767678 | 2025-09-28 03:02:49.767769 | LOOP [upload-logs : Compress console log and json output] 2025-09-28 03:02:49.823104 | localhost | skipping: Conditional result was False 2025-09-28 03:02:49.828756 | localhost | skipping: Conditional result was False 2025-09-28 03:02:49.832504 | 2025-09-28 03:02:49.832588 | LOOP [upload-logs : Upload compressed console log and json output] 2025-09-28 03:02:49.908127 | localhost | skipping: Conditional result was False 2025-09-28 03:02:49.908310 | 2025-09-28 03:02:49.912013 | localhost | skipping: Conditional result was False 2025-09-28 03:02:49.917027 | 2025-09-28 03:02:49.917110 | LOOP [upload-logs : Upload console log and json output]