2025-03-16 01:56:26.232378 | Job console starting... 2025-03-16 01:56:26.245271 | Updating repositories 2025-03-16 01:56:26.270023 | Preparing job workspace 2025-03-16 01:56:27.642418 | Running Ansible setup... 2025-03-16 01:56:32.900189 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-03-16 01:56:33.563546 | 2025-03-16 01:56:33.563669 | PLAY [Base pre] 2025-03-16 01:56:33.590826 | 2025-03-16 01:56:33.590948 | TASK [Setup log path fact] 2025-03-16 01:56:33.641443 | ubuntu-noble | ok 2025-03-16 01:56:33.672623 | 2025-03-16 01:56:33.672751 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-03-16 01:56:33.722776 | ubuntu-noble | ok 2025-03-16 01:56:33.729211 | 2025-03-16 01:56:33.729303 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-03-16 01:56:33.763066 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:33.769979 | 2025-03-16 01:56:33.770079 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-03-16 01:56:33.824052 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:33.832288 | 2025-03-16 01:56:33.832428 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-03-16 01:56:33.858991 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:33.866036 | 2025-03-16 01:56:33.866137 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-03-16 01:56:33.899826 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:33.906704 | 2025-03-16 01:56:33.906798 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-03-16 01:56:33.940617 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:33.964902 | 2025-03-16 01:56:33.965017 | TASK [emit-job-header : Print job information] 2025-03-16 01:56:34.015198 | # Job Information 2025-03-16 01:56:34.015350 | Ansible Version: 2.15.3 2025-03-16 01:56:34.015382 | Job: ansible-lint 2025-03-16 01:56:34.015410 | Pipeline: check 2025-03-16 01:56:34.015431 | Executor: 7d211f194f6a 2025-03-16 01:56:34.015450 | Triggered by: https://github.com/osism/cfg-cookiecutter/pull/715 2025-03-16 01:56:34.015468 | Event ID: d7ecffc0-0209-11f0-910e-3f14b7905e30 2025-03-16 01:56:34.022344 | 2025-03-16 01:56:34.022431 | LOOP [emit-job-header : Print node information] 2025-03-16 01:56:34.178427 | ubuntu-noble | ok: 2025-03-16 01:56:34.178718 | ubuntu-noble | # Node Information 2025-03-16 01:56:34.178763 | ubuntu-noble | Inventory Hostname: ubuntu-noble 2025-03-16 01:56:34.178789 | ubuntu-noble | Hostname: ubuntu 2025-03-16 01:56:34.178812 | ubuntu-noble | Username: zuul 2025-03-16 01:56:34.178832 | ubuntu-noble | Distro: Ubuntu 24.04 2025-03-16 01:56:34.178852 | ubuntu-noble | Provider: regiocloud-a 2025-03-16 01:56:34.178871 | ubuntu-noble | Label: ubuntu-noble 2025-03-16 01:56:34.178890 | ubuntu-noble | Product Name: OpenStack Nova 2025-03-16 01:56:34.178910 | ubuntu-noble | Interface IP: 81.163.193.156 2025-03-16 01:56:34.201095 | 2025-03-16 01:56:34.201209 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-03-16 01:56:34.651874 | ubuntu-noble -> localhost | changed 2025-03-16 01:56:34.660007 | 2025-03-16 01:56:34.660095 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-03-16 01:56:35.646011 | ubuntu-noble -> localhost | changed 2025-03-16 01:56:35.658529 | 2025-03-16 01:56:35.658631 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-03-16 01:56:35.889105 | ubuntu-noble -> localhost | ok 2025-03-16 01:56:35.897751 | 2025-03-16 01:56:35.897853 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-03-16 01:56:35.929702 | ubuntu-noble | ok 2025-03-16 01:56:35.945359 | ubuntu-noble | included: /var/lib/zuul/builds/997aa5d6cf614f50a033f919e45fb0fa/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-03-16 01:56:35.952761 | 2025-03-16 01:56:35.952842 | TASK [add-build-sshkey : Create Temp SSH key] 2025-03-16 01:56:36.597412 | ubuntu-noble -> localhost | Generating public/private rsa key pair. 2025-03-16 01:56:36.597597 | ubuntu-noble -> localhost | Your identification has been saved in /var/lib/zuul/builds/997aa5d6cf614f50a033f919e45fb0fa/work/997aa5d6cf614f50a033f919e45fb0fa_id_rsa 2025-03-16 01:56:36.597633 | ubuntu-noble -> localhost | Your public key has been saved in /var/lib/zuul/builds/997aa5d6cf614f50a033f919e45fb0fa/work/997aa5d6cf614f50a033f919e45fb0fa_id_rsa.pub 2025-03-16 01:56:36.597659 | ubuntu-noble -> localhost | The key fingerprint is: 2025-03-16 01:56:36.597682 | ubuntu-noble -> localhost | SHA256:m9EUdg/eqBcaPA2x6IYROGNFQ3MsUJJoVdxYFu7zIaM zuul-build-sshkey 2025-03-16 01:56:36.597705 | ubuntu-noble -> localhost | The key's randomart image is: 2025-03-16 01:56:36.597730 | ubuntu-noble -> localhost | +---[RSA 3072]----+ 2025-03-16 01:56:36.597751 | ubuntu-noble -> localhost | | o+@X==.=.o | 2025-03-16 01:56:36.597772 | ubuntu-noble -> localhost | | o *.+Bo+ B = | 2025-03-16 01:56:36.597792 | ubuntu-noble -> localhost | | . . o..o * = o | 2025-03-16 01:56:36.597811 | ubuntu-noble -> localhost | | = o = . | 2025-03-16 01:56:36.597830 | ubuntu-noble -> localhost | | . S = . | 2025-03-16 01:56:36.597848 | ubuntu-noble -> localhost | | o O o | 2025-03-16 01:56:36.597867 | ubuntu-noble -> localhost | | E o . | 2025-03-16 01:56:36.597887 | ubuntu-noble -> localhost | | | 2025-03-16 01:56:36.597906 | ubuntu-noble -> localhost | | | 2025-03-16 01:56:36.597926 | ubuntu-noble -> localhost | +----[SHA256]-----+ 2025-03-16 01:56:36.597972 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.192420 2025-03-16 01:56:36.605650 | 2025-03-16 01:56:36.605738 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-03-16 01:56:36.635461 | ubuntu-noble | ok 2025-03-16 01:56:36.655377 | ubuntu-noble | included: /var/lib/zuul/builds/997aa5d6cf614f50a033f919e45fb0fa/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-03-16 01:56:36.665099 | 2025-03-16 01:56:36.665210 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-03-16 01:56:36.689054 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:36.696041 | 2025-03-16 01:56:36.696134 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-03-16 01:56:37.483641 | ubuntu-noble | changed 2025-03-16 01:56:37.492525 | 2025-03-16 01:56:37.492619 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-03-16 01:56:37.817656 | ubuntu-noble | ok 2025-03-16 01:56:37.827210 | 2025-03-16 01:56:37.827312 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-03-16 01:56:38.667843 | ubuntu-noble | changed 2025-03-16 01:56:38.675630 | 2025-03-16 01:56:38.675744 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-03-16 01:56:39.472158 | ubuntu-noble | changed 2025-03-16 01:56:39.481560 | 2025-03-16 01:56:39.481687 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-03-16 01:56:39.516759 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:39.524723 | 2025-03-16 01:56:39.524829 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-03-16 01:56:39.894557 | ubuntu-noble -> localhost | changed 2025-03-16 01:56:39.912003 | 2025-03-16 01:56:39.912104 | TASK [add-build-sshkey : Add back temp key] 2025-03-16 01:56:40.211528 | ubuntu-noble -> localhost | Identity added: /var/lib/zuul/builds/997aa5d6cf614f50a033f919e45fb0fa/work/997aa5d6cf614f50a033f919e45fb0fa_id_rsa (zuul-build-sshkey) 2025-03-16 01:56:40.211733 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.011770 2025-03-16 01:56:40.218941 | 2025-03-16 01:56:40.219027 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-03-16 01:56:40.717669 | ubuntu-noble | ok 2025-03-16 01:56:40.723848 | 2025-03-16 01:56:40.723935 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-03-16 01:56:40.748097 | ubuntu-noble | skipping: Conditional result was False 2025-03-16 01:56:40.772902 | 2025-03-16 01:56:40.773024 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-03-16 01:56:41.257205 | ubuntu-noble | ok 2025-03-16 01:56:41.270595 | 2025-03-16 01:56:41.270686 | TASK [validate-host : Define zuul_info_dir fact] 2025-03-16 01:56:41.301913 | ubuntu-noble | ok 2025-03-16 01:56:41.307978 | 2025-03-16 01:56:41.308060 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-03-16 01:56:41.537450 | ubuntu-noble -> localhost | ok 2025-03-16 01:56:41.543617 | 2025-03-16 01:56:41.543693 | TASK [validate-host : Collect information about the host] 2025-03-16 01:56:42.817099 | ubuntu-noble | ok 2025-03-16 01:56:42.828243 | 2025-03-16 01:56:42.828324 | TASK [validate-host : Sanitize hostname] 2025-03-16 01:56:42.886468 | ubuntu-noble | ok 2025-03-16 01:56:42.891310 | 2025-03-16 01:56:42.891385 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-03-16 01:56:43.310887 | ubuntu-noble -> localhost | changed 2025-03-16 01:56:43.322823 | 2025-03-16 01:56:43.322956 | TASK [validate-host : Collect information about zuul worker] 2025-03-16 01:56:43.825426 | ubuntu-noble | ok 2025-03-16 01:56:43.838309 | 2025-03-16 01:56:43.838511 | TASK [validate-host : Write out all zuul information for each host] 2025-03-16 01:56:44.365877 | ubuntu-noble -> localhost | changed 2025-03-16 01:56:44.382195 | 2025-03-16 01:56:44.382293 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-03-16 01:56:44.786061 | ubuntu-noble | ok 2025-03-16 01:56:44.802378 | 2025-03-16 01:56:44.802467 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-03-16 01:56:45.644068 | ubuntu-noble | changed: 2025-03-16 01:56:45.644284 | ubuntu-noble | cd+++++++++ src/ 2025-03-16 01:56:45.644325 | ubuntu-noble | cd+++++++++ src/github.com/ 2025-03-16 01:56:45.644354 | ubuntu-noble | cd+++++++++ src/github.com/osism/ 2025-03-16 01:56:45.644381 | ubuntu-noble | cd+++++++++ src/github.com/osism/cfg-cookiecutter/ 2025-03-16 01:56:45.644424 | ubuntu-noble | Containerfile 2025-03-16 01:56:45.644578 | ubuntu-noble | localhost | ok: Runtime: 0:00:00.007064 2025-03-16 01:57:56.702447 | 2025-03-16 01:57:56.702580 | TASK [upload-logs : Upload logs to log server] 2025-03-16 01:57:57.324979 | localhost | Output suppressed because no_log was given 2025-03-16 01:57:57.328924 | 2025-03-16 01:57:57.329038 | LOOP [upload-logs : Compress console log and json output] 2025-03-16 01:57:57.396010 | localhost | skipping: Conditional result was False 2025-03-16 01:57:57.414027 | localhost | skipping: Conditional result was False 2025-03-16 01:57:57.427262 | 2025-03-16 01:57:57.427485 | LOOP [upload-logs : Upload compressed console log and json output] 2025-03-16 01:57:57.494504 | localhost | skipping: Conditional result was False 2025-03-16 01:57:57.495059 | 2025-03-16 01:57:57.513704 | localhost | skipping: Conditional result was False 2025-03-16 01:57:57.534104 | 2025-03-16 01:57:57.534315 | LOOP [upload-logs : Upload console log and json output]