2025-01-09 08:09:07.525263 | Job console starting... 2025-01-09 08:09:07.550214 | Updating repositories 2025-01-09 08:09:07.597523 | Preparing job workspace 2025-01-09 08:09:09.129058 | Running Ansible setup... 2025-01-09 08:09:14.407951 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main] 2025-01-09 08:09:15.192040 | 2025-01-09 08:09:15.192210 | PLAY [Base pre] 2025-01-09 08:09:15.222712 | 2025-01-09 08:09:15.222900 | TASK [Setup log path fact] 2025-01-09 08:09:15.256745 | ubuntu-noble | ok 2025-01-09 08:09:15.284993 | 2025-01-09 08:09:15.285167 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-01-09 08:09:15.347200 | ubuntu-noble | ok 2025-01-09 08:09:15.354305 | 2025-01-09 08:09:15.354431 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-01-09 08:09:15.389400 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:15.396951 | 2025-01-09 08:09:15.397081 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-01-09 08:09:15.442062 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:15.452614 | 2025-01-09 08:09:15.452856 | TASK [set-zuul-log-path-fact : Set log path for a change] 2025-01-09 08:09:15.479963 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:15.487715 | 2025-01-09 08:09:15.487886 | TASK [set-zuul-log-path-fact : Set log path for a ref update] 2025-01-09 08:09:15.515043 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:15.522972 | 2025-01-09 08:09:15.523115 | TASK [set-zuul-log-path-fact : Set log path for a periodic job] 2025-01-09 08:09:15.548209 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:15.563988 | 2025-01-09 08:09:15.564140 | TASK [emit-job-header : Print job information] 2025-01-09 08:09:15.616350 | # Job Information 2025-01-09 08:09:15.616621 | Ansible Version: 2.15.3 2025-01-09 08:09:15.616663 | Job: flake8 2025-01-09 08:09:15.616694 | Pipeline: check 2025-01-09 08:09:15.616715 | Executor: 7d211f194f6a 2025-01-09 08:09:15.616734 | Triggered by: https://github.com/osism/python-osism/pull/1173 2025-01-09 08:09:15.616753 | Event ID: fa5436a0-ce60-11ef-917a-746aed22eac7 2025-01-09 08:09:15.624482 | 2025-01-09 08:09:15.624597 | LOOP [emit-job-header : Print node information] 2025-01-09 08:09:15.790399 | ubuntu-noble | ok: 2025-01-09 08:09:15.790693 | ubuntu-noble | # Node Information 2025-01-09 08:09:15.790737 | ubuntu-noble | Inventory Hostname: ubuntu-noble 2025-01-09 08:09:15.790763 | ubuntu-noble | Hostname: ubuntu 2025-01-09 08:09:15.790787 | ubuntu-noble | Username: zuul 2025-01-09 08:09:15.790807 | ubuntu-noble | Distro: Ubuntu 24.04 2025-01-09 08:09:15.790867 | ubuntu-noble | Provider: regiocloud-a 2025-01-09 08:09:15.790889 | ubuntu-noble | Label: ubuntu-noble 2025-01-09 08:09:15.790909 | ubuntu-noble | Product Name: OpenStack Nova 2025-01-09 08:09:15.790929 | ubuntu-noble | Interface IP: 81.163.193.168 2025-01-09 08:09:15.815155 | 2025-01-09 08:09:15.815289 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-01-09 08:09:16.310525 | ubuntu-noble -> localhost | changed 2025-01-09 08:09:16.319278 | 2025-01-09 08:09:16.319396 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-01-09 08:09:17.434554 | ubuntu-noble -> localhost | changed 2025-01-09 08:09:17.445502 | 2025-01-09 08:09:17.445590 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-01-09 08:09:17.711941 | ubuntu-noble -> localhost | ok 2025-01-09 08:09:17.719302 | 2025-01-09 08:09:17.719392 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-01-09 08:09:17.747779 | ubuntu-noble | ok 2025-01-09 08:09:17.769806 | ubuntu-noble | included: /var/lib/zuul/builds/8af492a5c7284aa4b077f805af4050ea/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-01-09 08:09:17.777377 | 2025-01-09 08:09:17.777469 | TASK [add-build-sshkey : Create Temp SSH key] 2025-01-09 08:09:18.625927 | ubuntu-noble -> localhost | Generating public/private rsa key pair. 2025-01-09 08:09:18.626111 | ubuntu-noble -> localhost | Your identification has been saved in /var/lib/zuul/builds/8af492a5c7284aa4b077f805af4050ea/work/8af492a5c7284aa4b077f805af4050ea_id_rsa 2025-01-09 08:09:18.626147 | ubuntu-noble -> localhost | Your public key has been saved in /var/lib/zuul/builds/8af492a5c7284aa4b077f805af4050ea/work/8af492a5c7284aa4b077f805af4050ea_id_rsa.pub 2025-01-09 08:09:18.626172 | ubuntu-noble -> localhost | The key fingerprint is: 2025-01-09 08:09:18.626196 | ubuntu-noble -> localhost | SHA256:CniN/EN3aDUyLz3Codypr7O3+V+G1qrEKS2J+w2Bwb8 zuul-build-sshkey 2025-01-09 08:09:18.626217 | ubuntu-noble -> localhost | The key's randomart image is: 2025-01-09 08:09:18.626242 | ubuntu-noble -> localhost | +---[RSA 3072]----+ 2025-01-09 08:09:18.626264 | ubuntu-noble -> localhost | | | 2025-01-09 08:09:18.626285 | ubuntu-noble -> localhost | | . | 2025-01-09 08:09:18.626304 | ubuntu-noble -> localhost | | o + o | 2025-01-09 08:09:18.626324 | ubuntu-noble -> localhost | | o + B X . | 2025-01-09 08:09:18.626343 | ubuntu-noble -> localhost | | . = * S = | 2025-01-09 08:09:18.626362 | ubuntu-noble -> localhost | | . + * X o o | 2025-01-09 08:09:18.626381 | ubuntu-noble -> localhost | | * E = o + | 2025-01-09 08:09:18.626400 | ubuntu-noble -> localhost | | .+.B . + | 2025-01-09 08:09:18.626420 | ubuntu-noble -> localhost | | +*=o+oo | 2025-01-09 08:09:18.626439 | ubuntu-noble -> localhost | +----[SHA256]-----+ 2025-01-09 08:09:18.626491 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.379053 2025-01-09 08:09:18.633808 | 2025-01-09 08:09:18.633941 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-01-09 08:09:18.678955 | ubuntu-noble | ok 2025-01-09 08:09:18.689405 | ubuntu-noble | included: /var/lib/zuul/builds/8af492a5c7284aa4b077f805af4050ea/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-01-09 08:09:18.698895 | 2025-01-09 08:09:18.698987 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-01-09 08:09:18.722785 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:18.731029 | 2025-01-09 08:09:18.731136 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-01-09 08:09:19.464107 | ubuntu-noble | changed 2025-01-09 08:09:19.474356 | 2025-01-09 08:09:19.474495 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-01-09 08:09:19.791708 | ubuntu-noble | ok 2025-01-09 08:09:19.800527 | 2025-01-09 08:09:19.800655 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-01-09 08:09:20.531776 | ubuntu-noble | changed 2025-01-09 08:09:20.540311 | 2025-01-09 08:09:20.540409 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-01-09 08:09:21.325770 | ubuntu-noble | changed 2025-01-09 08:09:21.332648 | 2025-01-09 08:09:21.332739 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-01-09 08:09:21.357040 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:21.364114 | 2025-01-09 08:09:21.364205 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-01-09 08:09:21.779203 | ubuntu-noble -> localhost | changed 2025-01-09 08:09:21.792257 | 2025-01-09 08:09:21.792366 | TASK [add-build-sshkey : Add back temp key] 2025-01-09 08:09:22.099814 | ubuntu-noble -> localhost | Identity added: /var/lib/zuul/builds/8af492a5c7284aa4b077f805af4050ea/work/8af492a5c7284aa4b077f805af4050ea_id_rsa (zuul-build-sshkey) 2025-01-09 08:09:22.100048 | ubuntu-noble -> localhost | ok: Runtime: 0:00:00.015842 2025-01-09 08:09:22.107433 | 2025-01-09 08:09:22.107520 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-01-09 08:09:22.589357 | ubuntu-noble | ok 2025-01-09 08:09:22.595516 | 2025-01-09 08:09:22.595597 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-01-09 08:09:22.629949 | ubuntu-noble | skipping: Conditional result was False 2025-01-09 08:09:22.665451 | 2025-01-09 08:09:22.665547 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-01-09 08:09:23.071686 | ubuntu-noble | ok 2025-01-09 08:09:23.084876 | 2025-01-09 08:09:23.084962 | TASK [validate-host : Define zuul_info_dir fact] 2025-01-09 08:09:23.114401 | ubuntu-noble | ok 2025-01-09 08:09:23.120683 | 2025-01-09 08:09:23.120773 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-01-09 08:09:23.388721 | ubuntu-noble -> localhost | ok 2025-01-09 08:09:23.396203 | 2025-01-09 08:09:23.396290 | TASK [validate-host : Collect information about the host] 2025-01-09 08:09:24.566623 | ubuntu-noble | ok 2025-01-09 08:09:24.578563 | 2025-01-09 08:09:24.578655 | TASK [validate-host : Sanitize hostname] 2025-01-09 08:09:24.651079 | ubuntu-noble | ok 2025-01-09 08:09:24.656978 | 2025-01-09 08:09:24.657062 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-01-09 08:09:25.158646 | ubuntu-noble -> localhost | changed 2025-01-09 08:09:25.165372 | 2025-01-09 08:09:25.165474 | TASK [validate-host : Collect information about zuul worker] 2025-01-09 08:09:25.649844 | ubuntu-noble | ok 2025-01-09 08:09:25.658286 | 2025-01-09 08:09:25.658405 | TASK [validate-host : Write out all zuul information for each host] 2025-01-09 08:09:26.186347 | ubuntu-noble -> localhost | changed 2025-01-09 08:09:26.201319 | 2025-01-09 08:09:26.201452 | TASK [prepare-workspace-log : Start zuul_console daemon.] 2025-01-09 08:09:26.531189 | ubuntu-noble | ok 2025-01-09 08:09:26.539155 | 2025-01-09 08:09:26.539278 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.] 2025-01-09 08:09:27.695877 | ubuntu-noble | changed: 2025-01-09 08:09:27.696171 | ubuntu-noble | cd+++++++++ src/ 2025-01-09 08:09:27.703914 | ubuntu-noble | cd+++++++++ src/github.com/ 2025-01-09 08:09:27.703990 | ubuntu-noble | cd+++++++++ src/github.com/osism/ 2025-01-09 08:09:27.704025 | ubuntu-noble | cd+++++++++ src/github.com/osism/python-osism/ 2025-01-09 08:09:27.704054 | ubuntu-noble | Containerfile 2025-01-09 08:09:27.704210 | ubuntu-noble | localhost | ok: Runtime: 0:00:00.007534 2025-01-09 08:10:29.014294 | 2025-01-09 08:10:29.014515 | TASK [upload-logs : Upload logs to log server] 2025-01-09 08:10:29.618622 | localhost | Output suppressed because no_log was given 2025-01-09 08:10:29.623994 | 2025-01-09 08:10:29.624148 | LOOP [upload-logs : Compress console log and json output] 2025-01-09 08:10:29.699593 | localhost | skipping: Conditional result was False 2025-01-09 08:10:29.717245 | localhost | skipping: Conditional result was False 2025-01-09 08:10:29.730996 | 2025-01-09 08:10:29.731191 | LOOP [upload-logs : Upload compressed console log and json output] 2025-01-09 08:10:29.797624 | localhost | skipping: Conditional result was False 2025-01-09 08:10:29.797988 | 2025-01-09 08:10:29.810589 | localhost | skipping: Conditional result was False 2025-01-09 08:10:29.828474 | 2025-01-09 08:10:29.828664 | LOOP [upload-logs : Upload console log and json output]