2025-05-24 02:10:33.427991 | Job console starting 2025-05-24 02:10:33.462148 | Updating git repos 2025-05-24 02:10:33.537992 | Cloning repos into workspace 2025-05-24 02:10:33.591817 | Restoring repo states 2025-05-24 02:10:33.618327 | Merging changes 2025-05-24 02:10:34.163324 | Checking out repos 2025-05-24 02:10:34.276959 | Preparing playbooks 2025-05-24 02:10:35.319211 | Running Ansible setup 2025-05-24 02:10:41.194824 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-05-24 02:10:42.501698 | 2025-05-24 02:10:42.501873 | PLAY [Base pre] 2025-05-24 02:10:42.518697 | 2025-05-24 02:10:42.518892 | TASK [Setup log path fact] 2025-05-24 02:10:42.569590 | debian-bookworm | ok 2025-05-24 02:10:42.599181 | 2025-05-24 02:10:42.599350 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-05-24 02:10:42.691296 | debian-bookworm | ok 2025-05-24 02:10:42.731660 | 2025-05-24 02:10:42.731820 | TASK [emit-job-header : Print job information] 2025-05-24 02:10:42.833234 | # Job Information 2025-05-24 02:10:42.833449 | Ansible Version: 2.16.14 2025-05-24 02:10:42.833487 | Job: container-image-python-osism-build 2025-05-24 02:10:42.833520 | Pipeline: check 2025-05-24 02:10:42.833544 | Executor: 521e9411259a 2025-05-24 02:10:42.833565 | Triggered by: https://github.com/osism/python-osism/pull/1369 2025-05-24 02:10:42.833590 | Event ID: 406926d0-3844-11f0-98b1-d41028559847 2025-05-24 02:10:42.840660 | 2025-05-24 02:10:42.840788 | LOOP [emit-job-header : Print node information] 2025-05-24 02:10:42.961981 | debian-bookworm | ok: 2025-05-24 02:10:42.962269 | debian-bookworm | # Node Information 2025-05-24 02:10:42.962315 | debian-bookworm | Inventory Hostname: debian-bookworm 2025-05-24 02:10:42.962342 | debian-bookworm | Hostname: debian 2025-05-24 02:10:42.962365 | debian-bookworm | Username: zuul 2025-05-24 02:10:42.962386 | debian-bookworm | Distro: Debian 12.11 2025-05-24 02:10:42.962410 | debian-bookworm | Provider: regiocloud-a 2025-05-24 02:10:42.962431 | debian-bookworm | Region: 2025-05-24 02:10:42.962454 | debian-bookworm | Label: debian-bookworm 2025-05-24 02:10:42.962473 | debian-bookworm | Product Name: OpenStack Nova 2025-05-24 02:10:42.962493 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe5e:d6c7 2025-05-24 02:10:42.989110 | 2025-05-24 02:10:42.989262 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-05-24 02:10:43.621306 | debian-bookworm -> localhost | changed 2025-05-24 02:10:43.628825 | 2025-05-24 02:10:43.628958 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-05-24 02:10:45.347072 | debian-bookworm -> localhost | changed 2025-05-24 02:10:45.360966 | 2025-05-24 02:10:45.361076 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-05-24 02:10:45.777256 | debian-bookworm -> localhost | ok 2025-05-24 02:10:45.783477 | 2025-05-24 02:10:45.783585 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-05-24 02:10:45.812475 | debian-bookworm | ok 2025-05-24 02:10:45.837820 | debian-bookworm | included: /var/lib/zuul/builds/4646a8c095914fe8b1fc82ef032b08d8/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-05-24 02:10:45.843920 | 2025-05-24 02:10:45.844015 | TASK [add-build-sshkey : Create Temp SSH key] 2025-05-24 02:10:47.760009 | debian-bookworm -> localhost | Generating public/private rsa key pair. 2025-05-24 02:10:47.760316 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/4646a8c095914fe8b1fc82ef032b08d8/work/4646a8c095914fe8b1fc82ef032b08d8_id_rsa 2025-05-24 02:10:47.760373 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/4646a8c095914fe8b1fc82ef032b08d8/work/4646a8c095914fe8b1fc82ef032b08d8_id_rsa.pub 2025-05-24 02:10:47.760412 | debian-bookworm -> localhost | The key fingerprint is: 2025-05-24 02:10:47.760448 | debian-bookworm -> localhost | SHA256:+Z5YoaceygpisS5SSakzS2kRIkVriBRn88YPOBhLY74 zuul-build-sshkey 2025-05-24 02:10:47.760493 | debian-bookworm -> localhost | The key's randomart image is: 2025-05-24 02:10:47.760526 | debian-bookworm -> localhost | +---[RSA 3072]----+ 2025-05-24 02:10:47.760556 | debian-bookworm -> localhost | | X++ | 2025-05-24 02:10:47.760587 | debian-bookworm -> localhost | |OoB.= | 2025-05-24 02:10:47.760630 | debian-bookworm -> localhost | |=+++ = | 2025-05-24 02:10:47.760660 | debian-bookworm -> localhost | | o+ o o . | 2025-05-24 02:10:47.760689 | debian-bookworm -> localhost | | Eo. .S . | 2025-05-24 02:10:47.760723 | debian-bookworm -> localhost | |++= o . | 2025-05-24 02:10:47.760752 | debian-bookworm -> localhost | |+B. o + | 2025-05-24 02:10:47.760780 | debian-bookworm -> localhost | |*. . . . B . | 2025-05-24 02:10:47.760809 | debian-bookworm -> localhost | |o. ..o.+ o | 2025-05-24 02:10:47.760840 | debian-bookworm -> localhost | +----[SHA256]-----+ 2025-05-24 02:10:47.760904 | debian-bookworm -> localhost | ok: Runtime: 0:00:01.253189 2025-05-24 02:10:47.769165 | 2025-05-24 02:10:47.769275 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-05-24 02:10:47.788940 | debian-bookworm | ok 2025-05-24 02:10:47.798357 | debian-bookworm | included: /var/lib/zuul/builds/4646a8c095914fe8b1fc82ef032b08d8/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-05-24 02:10:47.807092 | 2025-05-24 02:10:47.807176 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-05-24 02:10:47.831001 | debian-bookworm | skipping: Conditional result was False 2025-05-24 02:10:47.837537 | 2025-05-24 02:10:47.837648 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-05-24 02:10:48.471647 | debian-bookworm | changed 2025-05-24 02:10:48.478239 | 2025-05-24 02:10:48.478341 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-05-24 02:10:48.729718 | debian-bookworm | ok 2025-05-24 02:10:48.735442 | 2025-05-24 02:10:48.735530 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-05-24 02:10:49.349347 | debian-bookworm | changed 2025-05-24 02:10:49.357958 | 2025-05-24 02:10:49.358075 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-05-24 02:10:50.001985 | debian-bookworm | changed 2025-05-24 02:10:50.007515 | 2025-05-24 02:10:50.007636 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-05-24 02:10:50.031356 | debian-bookworm | skipping: Conditional result was False 2025-05-24 02:10:50.037281 | 2025-05-24 02:10:50.037380 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-05-24 02:10:50.573896 | debian-bookworm -> localhost | changed 2025-05-24 02:10:50.584520 | 2025-05-24 02:10:50.584637 | TASK [add-build-sshkey : Add back temp key] 2025-05-24 02:10:51.100086 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/4646a8c095914fe8b1fc82ef032b08d8/work/4646a8c095914fe8b1fc82ef032b08d8_id_rsa (zuul-build-sshkey) 2025-05-24 02:10:51.103259 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.017695 2025-05-24 02:10:51.159962 | 2025-05-24 02:10:51.161029 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-05-24 02:10:51.767942 | debian-bookworm | ok 2025-05-24 02:10:51.808482 | 2025-05-24 02:10:51.809328 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-05-24 02:10:51.925493 | debian-bookworm | skipping: Conditional result was False 2025-05-24 02:10:51.996245 | 2025-05-24 02:10:51.996950 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-05-24 02:10:52.784160 | debian-bookworm | ok 2025-05-24 02:10:52.840934 | 2025-05-24 02:10:52.841750 | TASK [validate-host : Define zuul_info_dir fact] 2025-05-24 02:10:52.964471 | debian-bookworm | ok 2025-05-24 02:10:52.991703 | 2025-05-24 02:10:52.992380 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-05-24 02:10:53.651396 | debian-bookworm -> localhost | ok 2025-05-24 02:10:53.661884 | 2025-05-24 02:10:53.662348 | TASK [validate-host : Collect information about the host] 2025-05-24 02:10:54.985167 | debian-bookworm | ok 2025-05-24 02:10:55.044245 | 2025-05-24 02:10:55.045462 | TASK [validate-host : Sanitize hostname] 2025-05-24 02:10:55.299683 | debian-bookworm | ok 2025-05-24 02:10:55.451558 | 2025-05-24 02:10:55.451792 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-05-24 02:10:56.676550 | debian-bookworm -> localhost | changed 2025-05-24 02:10:56.693093 | 2025-05-24 02:10:56.693234 | TASK [validate-host : Collect information about zuul worker] 2025-05-24 02:10:57.434137 | debian-bookworm | ok 2025-05-24 02:10:57.447957 | 2025-05-24 02:10:57.448091 | TASK [validate-host : Write out all zuul information for each host] 2025-05-24 02:10:58.760590 | debian-bookworm -> localhost | changed 2025-05-24 02:10:58.845230 | 2025-05-24 02:10:58.845445 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-05-24 02:10:59.249057 | debian-bookworm | ok 2025-05-24 02:10:59.370147 | 2025-05-24 02:10:59.372096 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-05-24 02:11:01.026490 | debian-bookworm | changed: 2025-05-24 02:11:01.026763 | debian-bookworm | cd+++++++++ src/ 2025-05-24 02:11:01.026798 | debian-bookworm | cd+++++++++ src/github.com/ 2025-05-24 02:11:01.026823 | debian-bookworm | cd+++++++++ src/github.com/osism/ 2025-05-24 02:11:01.026869 | debian-bookworm | cd+++++++++ src/github.com/osism/python-osism/ 2025-05-24 02:11:01.026890 | debian-bookworm | Containerfile 2025-05-24 02:11:01.027006 | debian-bookworm | localhost | ok: Runtime: 0:00:00.007665 2025-05-24 02:14:21.716576 | 2025-05-24 02:14:21.716743 | TASK [upload-logs : Upload logs to log server] 2025-05-24 02:14:22.306116 | localhost | Output suppressed because no_log was given 2025-05-24 02:14:22.310666 | 2025-05-24 02:14:22.310915 | LOOP [upload-logs : Compress console log and json output] 2025-05-24 02:14:22.378938 | localhost | skipping: Conditional result was False 2025-05-24 02:14:22.383721 | localhost | skipping: Conditional result was False 2025-05-24 02:14:22.398242 | 2025-05-24 02:14:22.398490 | LOOP [upload-logs : Upload compressed console log and json output] 2025-05-24 02:14:22.448747 | localhost | skipping: Conditional result was False 2025-05-24 02:14:22.449344 | 2025-05-24 02:14:22.452659 | localhost | skipping: Conditional result was False 2025-05-24 02:14:22.460605 | 2025-05-24 02:14:22.460901 | LOOP [upload-logs : Upload console log and json output]