2025-02-27 18:18:40.289219 | Job console starting... 2025-02-27 18:18:40.301249 | Updating repositories 2025-02-27 18:18:40.387879 | Preparing job workspace 2025-02-27 18:18:42.837949 | Running Ansible setup... 2025-02-27 18:18:49.875791 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-02-27 18:18:51.043450 | 2025-02-27 18:18:51.043631 | PLAY [Base pre] 2025-02-27 18:18:51.075198 | 2025-02-27 18:18:51.075368 | TASK [Setup log path fact] 2025-02-27 18:18:51.130699 | ubuntu-noble | ok 2025-02-27 18:18:51.175076 | 2025-02-27 18:18:51.175239 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-02-27 18:18:51.300263 | ubuntu-noble | ok 2025-02-27 18:18:51.333622 | 2025-02-27 18:18:51.333773 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-02-27 18:18:51.431240 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:18:51.439136 | 2025-02-27 18:18:51.439274 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-02-27 18:18:51.507010 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:18:51.515192 | 2025-02-27 18:18:51.515382 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-02-27 18:18:51.575400 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:18:51.583166 | 2025-02-27 18:18:51.583291 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-02-27 18:18:51.632671 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:18:51.653360 | 2025-02-27 18:18:51.653518 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-02-27 18:18:51.720867 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:18:51.742741 | 2025-02-27 18:18:51.742882 | TASK [emit-job-header : Print job information] 2025-02-27 18:18:51.859548 | # Job Information 2025-02-27 18:18:51.859725 | Ansible Version: 2.15.3 2025-02-27 18:18:51.859752 | Job: mypy 2025-02-27 18:18:51.859777 | Pipeline: check 2025-02-27 18:18:51.859794 | Executor: 7d211f194f6a 2025-02-27 18:18:51.859809 | Triggered by: https://github.com/osism/python-osism/pull/1191 2025-02-27 18:18:51.859825 | Event ID: 407301a0-f537-11ef-8c15-69a4a17a24cd 2025-02-27 18:18:51.865434 | 2025-02-27 18:18:51.865534 | LOOP [emit-job-header : Print node information] 2025-02-27 18:18:52.069858 | ubuntu-noble | ok: 2025-02-27 18:18:52.070022 | ubuntu-noble | # Node Information 2025-02-27 18:18:52.070057 | ubuntu-noble | Inventory Hostname: ubuntu-noble 2025-02-27 18:18:52.070082 | ubuntu-noble | Hostname: ubuntu 2025-02-27 18:18:52.070104 | ubuntu-noble | Username: zuul 2025-02-27 18:18:52.070124 | ubuntu-noble | Distro: Ubuntu 24.04 2025-02-27 18:18:52.070144 | ubuntu-noble | Provider: regiocloud-a 2025-02-27 18:18:52.070163 | ubuntu-noble | Label: ubuntu-noble 2025-02-27 18:18:52.070182 | ubuntu-noble | Product Name: OpenStack Nova 2025-02-27 18:18:52.070202 | ubuntu-noble | Interface IP: 81.163.192.35 2025-02-27 18:18:52.089113 | 2025-02-27 18:18:52.089198 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-02-27 18:18:53.135716 | ubuntu-noble -> localhost | changed 2025-02-27 18:18:53.143159 | 2025-02-27 18:18:53.143237 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-02-27 18:18:54.289845 | ubuntu-noble -> localhost | changed 2025-02-27 18:18:54.307014 | 2025-02-27 18:18:54.307098 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-02-27 18:18:54.723433 | ubuntu-noble -> localhost | ok 2025-02-27 18:18:54.729806 | 2025-02-27 18:18:54.729887 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-02-27 18:18:54.768662 | ubuntu-noble | ok 2025-02-27 18:18:54.792244 | ubuntu-noble | included: /var/lib/zuul/builds/6ec8ceb53ea041f8b9d779ca4c7a027d/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-02-27 18:18:54.809429 | 2025-02-27 18:18:54.809502 | TASK [add-build-sshkey : Create Temp SSH key] 2025-02-27 18:18:55.725136 | ubuntu-noble -> localhost | Generating public/private rsa key pair. 2025-02-27 18:18:55.725346 | ubuntu-noble -> localhost | Your identification has been saved in /var/lib/zuul/builds/6ec8ceb53ea041f8b9d779ca4c7a027d/work/6ec8ceb53ea041f8b9d779ca4c7a027d_id_rsa 2025-02-27 18:18:55.725379 | ubuntu-noble -> localhost | Your public key has been saved in /var/lib/zuul/builds/6ec8ceb53ea041f8b9d779ca4c7a027d/work/6ec8ceb53ea041f8b9d779ca4c7a027d_id_rsa.pub 2025-02-27 18:18:55.725400 | ubuntu-noble -> localhost | The key fingerprint is: 2025-02-27 18:18:55.725419 | ubuntu-noble -> localhost | SHA256:WwJVTL26etVhYA6gtYOICij//OTzJnB5Nsduw3N7Hbk zuul-build-sshkey 2025-02-27 18:18:55.725436 | ubuntu-noble -> localhost | The key's randomart image is: 2025-02-27 18:18:55.725456 | ubuntu-noble -> localhost | +---[RSA 3072]----+ 2025-02-27 18:18:55.725473 | ubuntu-noble -> localhost | | +=o. | 2025-02-27 18:18:55.725489 | ubuntu-noble -> localhost | |. . . = .o + | 2025-02-27 18:18:55.725504 | ubuntu-noble -> localhost | |+ . . + o + o | 2025-02-27 18:18:55.725520 | ubuntu-noble -> localhost | |oo . . o o | 2025-02-27 18:18:55.725536 | ubuntu-noble -> localhost | |. . .S... o ..| 2025-02-27 18:18:55.725551 | ubuntu-noble -> localhost | | o. o +++ . .o | 2025-02-27 18:18:55.725567 | ubuntu-noble -> localhost | | oo.o.= o .o| 2025-02-27 18:18:55.725583 | ubuntu-noble -> localhost | | +o . O . .E.| 2025-02-27 18:18:55.725600 | ubuntu-noble -> localhost | | o=o+ +.o | 2025-02-27 18:18:55.725616 | ubuntu-noble -> localhost | +----[SHA256]-----+ 2025-02-27 18:18:55.725656 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.140109 2025-02-27 18:18:55.731774 | 2025-02-27 18:18:55.731846 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-02-27 18:18:55.792733 | ubuntu-noble | ok 2025-02-27 18:18:55.813168 | ubuntu-noble | included: /var/lib/zuul/builds/6ec8ceb53ea041f8b9d779ca4c7a027d/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-02-27 18:18:55.832193 | 2025-02-27 18:18:55.832270 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-02-27 18:18:55.876742 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:18:55.882819 | 2025-02-27 18:18:55.882899 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-02-27 18:18:57.167093 | ubuntu-noble | changed 2025-02-27 18:18:57.175262 | 2025-02-27 18:18:57.175412 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-02-27 18:18:57.575284 | ubuntu-noble | ok 2025-02-27 18:18:57.581083 | 2025-02-27 18:18:57.581154 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-02-27 18:18:58.393584 | ubuntu-noble | changed 2025-02-27 18:18:58.401882 | 2025-02-27 18:18:58.401956 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-02-27 18:18:59.154914 | ubuntu-noble | changed 2025-02-27 18:18:59.163472 | 2025-02-27 18:18:59.164132 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-02-27 18:18:59.197826 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:18:59.217788 | 2025-02-27 18:18:59.218466 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-02-27 18:18:59.909176 | ubuntu-noble -> localhost | changed 2025-02-27 18:18:59.960162 | 2025-02-27 18:18:59.960292 | TASK [add-build-sshkey : Add back temp key] 2025-02-27 18:19:00.635187 | ubuntu-noble -> localhost | Identity added: /var/lib/zuul/builds/6ec8ceb53ea041f8b9d779ca4c7a027d/work/6ec8ceb53ea041f8b9d779ca4c7a027d_id_rsa (zuul-build-sshkey) 2025-02-27 18:19:00.635507 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.014304 2025-02-27 18:19:00.646277 | 2025-02-27 18:19:00.646508 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-02-27 18:19:01.221087 | ubuntu-noble | ok 2025-02-27 18:19:01.253512 | 2025-02-27 18:19:01.253621 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-02-27 18:19:01.348870 | ubuntu-noble | skipping: Conditional result was False 2025-02-27 18:19:01.382415 | 2025-02-27 18:19:01.383291 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-02-27 18:19:02.086272 | ubuntu-noble | ok 2025-02-27 18:19:02.100988 | 2025-02-27 18:19:02.101077 | TASK [validate-host : Define zuul_info_dir fact] 2025-02-27 18:19:02.131419 | ubuntu-noble | ok 2025-02-27 18:19:02.141206 | 2025-02-27 18:19:02.141290 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-02-27 18:19:02.445059 | ubuntu-noble -> localhost | ok 2025-02-27 18:19:02.453197 | 2025-02-27 18:19:02.453369 | TASK [validate-host : Collect information about the host] 2025-02-27 18:19:03.695409 | ubuntu-noble | ok 2025-02-27 18:19:03.723508 | 2025-02-27 18:19:03.723614 | TASK [validate-host : Sanitize hostname] 2025-02-27 18:19:03.824191 | ubuntu-noble | ok 2025-02-27 18:19:03.835926 | 2025-02-27 18:19:03.836028 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-02-27 18:19:04.452232 | ubuntu-noble -> localhost | changed 2025-02-27 18:19:04.462048 | 2025-02-27 18:19:04.462235 | TASK [validate-host : Collect information about zuul worker] 2025-02-27 18:19:04.990284 | ubuntu-noble | ok 2025-02-27 18:19:04.997788 | 2025-02-27 18:19:04.997873 | TASK [validate-host : Write out all zuul information for each host] 2025-02-27 18:19:05.895645 | ubuntu-noble -> localhost | changed 2025-02-27 18:19:05.910114 | 2025-02-27 18:19:05.910215 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-02-27 18:19:06.351996 | ubuntu-noble | ok 2025-02-27 18:19:06.358786 | 2025-02-27 18:19:06.358878 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-02-27 18:19:07.408173 | ubuntu-noble | changed: 2025-02-27 18:19:07.408419 | ubuntu-noble | cd+++++++++ src/ 2025-02-27 18:19:07.408465 | ubuntu-noble | cd+++++++++ src/github.com/ 2025-02-27 18:19:07.408490 | ubuntu-noble | cd+++++++++ src/github.com/osism/ 2025-02-27 18:19:07.408512 | ubuntu-noble | cd+++++++++ src/github.com/osism/python-osism/ 2025-02-27 18:19:07.408532 | ubuntu-noble | Containerfile 2025-02-27 18:19:07.408641 | ubuntu-noble | =2 in /tmp/venv/lib/python3.12/site-packages (from types-requests) (2.3.0) 2025-02-27 18:21:12.379368 | ubuntu-noble | Downloading types_PyYAML-6.0.12.20241230-py3-none-any.whl (20 kB) 2025-02-27 18:21:12.410305 | ubuntu-noble | Downloading types_decorator-5.2.0.20250224-py3-none-any.whl (8.1 kB) 2025-02-27 18:21:12.440882 | ubuntu-noble | Downloading types_python_dateutil-2.9.0.20241206-py3-none-any.whl (14 kB) 2025-02-27 18:21:12.473797 | ubuntu-noble | Downloading types_pytz-2025.1.0.20250204-py3-none-any.whl (10 kB) 2025-02-27 18:21:12.507833 | ubuntu-noble | Downloading types_requests-2.32.0.20241016-py3-none-any.whl (15 kB) 2025-02-27 18:21:12.541031 | ubuntu-noble | Downloading types_simplejson-3.20.0.20250218-py3-none-any.whl (10 kB) 2025-02-27 18:21:12.573407 | ubuntu-noble | Downloading types_tabulate-0.9.0.20241207-py3-none-any.whl (8.3 kB) 2025-02-27 18:21:12.605448 | ubuntu-noble | Downloading types_ujson-5.10.0.20240515-py3-none-any.whl (2.8 kB) 2025-02-27 18:21:13.343097 | ubuntu-noble | Installing collected packages: types-ujson, types-tabulate, types-simplejson, types-requests, types-PyYAML, types-pytz, types-python-dateutil, types-decorator 2025-02-27 18:21:13.765601 | ubuntu-noble | Successfully installed types-PyYAML-6.0.12.20241230 types-decorator-5.2.0.20250224 types-python-dateutil-2.9.0.20241206 types-pytz-2025.1.0.20250204 types-requests-2.32.0.20241016 types-simplejson-3.20.0.20250218 types-tabulate-0.9.0.20241207 types-ujson-5.10.0.20240515 2025-02-27 18:21:25.795526 | ubuntu-noble | Installing missing stub packages: 2025-02-27 18:21:25.827544 | ubuntu-noble | /tmp/venv/bin/python3 -m pip install types-PyYAML types-decorator types-python-dateutil types-pytz types-requests types-simplejson types-tabulate types-ujson 2025-02-27 18:21:25.827769 | ubuntu-noble | 2025-02-27 18:21:25.827788 | ubuntu-noble | 2025-02-27 18:21:25.827810 | ubuntu-noble | Success: no issues found in 55 source files 2025-02-27 18:21:25.999404 | ubuntu-noble | ok 2025-02-27 18:21:26.049169 | 2025-02-27 18:21:26.049299 | PLAY RECAP 2025-02-27 18:21:26.049364 | ubuntu-noble | ok: 11 changed: 7 unreachable: 0 failed: 0 skipped: 12 rescued: 0 ignored: 0 2025-02-27 18:21:26.049391 | 2025-02-27 18:21:26.152199 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/zuul-jobs/playbooks/mypy/run.yaml@main] 2025-02-27 18:21:26.154735 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2025-02-27 18:21:26.820239 | 2025-02-27 18:21:26.820353 | PLAY [Base post] 2025-02-27 18:21:26.844331 | 2025-02-27 18:21:26.844447 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2025-02-27 18:21:27.508805 | ubuntu-noble | changed 2025-02-27 18:21:27.542820 | 2025-02-27 18:21:27.542947 | PLAY RECAP 2025-02-27 18:21:27.543011 | ubuntu-noble | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-02-27 18:21:27.543072 | 2025-02-27 18:21:27.625918 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main] 2025-02-27 18:21:27.628303 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main] 2025-02-27 18:21:28.309630 | 2025-02-27 18:21:28.309749 | PLAY [Base post-logs] 2025-02-27 18:21:28.324602 | 2025-02-27 18:21:28.324707 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2025-02-27 18:21:28.756789 | localhost | changed 2025-02-27 18:21:28.763149 | 2025-02-27 18:21:28.763322 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2025-02-27 18:21:28.795701 | localhost | ok 2025-02-27 18:21:28.806001 | 2025-02-27 18:21:28.806161 | TASK [Set zuul-log-path fact] 2025-02-27 18:21:28.825889 | localhost | ok 2025-02-27 18:21:28.841944 | 2025-02-27 18:21:28.842035 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-02-27 18:21:28.892940 | localhost | ok 2025-02-27 18:21:28.898689 | 2025-02-27 18:21:28.898839 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-02-27 18:21:28.934445 | localhost | skipping: Conditional result was False 2025-02-27 18:21:28.942893 | 2025-02-27 18:21:28.943102 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-02-27 18:21:28.983032 | localhost | skipping: Conditional result was False 2025-02-27 18:21:28.990058 | 2025-02-27 18:21:28.990209 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-02-27 18:21:29.006804 | localhost | skipping: Conditional result was False 2025-02-27 18:21:29.012300 | 2025-02-27 18:21:29.012475 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-02-27 18:21:29.028189 | localhost | skipping: Conditional result was False 2025-02-27 18:21:29.032585 | 2025-02-27 18:21:29.032691 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-02-27 18:21:29.047449 | localhost | skipping: Conditional result was False 2025-02-27 18:21:29.054354 | 2025-02-27 18:21:29.054439 | TASK [upload-logs : Create log directories] 2025-02-27 18:21:29.575397 | localhost | changed 2025-02-27 18:21:29.583115 | 2025-02-27 18:21:29.583331 | TASK [upload-logs : Ensure logs are readable before uploading] 2025-02-27 18:21:30.136417 | localhost -> localhost | ok: Runtime: 0:00:00.008197 2025-02-27 18:21:30.146179 | 2025-02-27 18:21:30.146356 | TASK [upload-logs : Upload logs to log server] 2025-02-27 18:21:30.751506 | localhost | Output suppressed because no_log was given 2025-02-27 18:21:30.754911 | 2025-02-27 18:21:30.755027 | LOOP [upload-logs : Compress console log and json output] 2025-02-27 18:21:30.831725 | localhost | skipping: Conditional result was False 2025-02-27 18:21:30.849195 | localhost | skipping: Conditional result was False 2025-02-27 18:21:30.862710 | 2025-02-27 18:21:30.862901 | LOOP [upload-logs : Upload compressed console log and json output] 2025-02-27 18:21:30.937505 | localhost | skipping: Conditional result was False 2025-02-27 18:21:30.938143 | 2025-02-27 18:21:30.948507 | localhost | skipping: Conditional result was False 2025-02-27 18:21:30.960165 | 2025-02-27 18:21:30.960381 | LOOP [upload-logs : Upload console log and json output]