2025-12-01 09:30:36.829134 | Job console starting... 2025-12-01 09:30:36.843994 | Updating repositories 2025-12-01 09:30:36.876595 | Preparing job workspace 2025-12-01 09:30:40.785530 | Running Ansible setup... 2025-12-01 09:30:45.615881 | PRE-RUN START: [trusted : github.com/ansible/zuul-config/playbooks/base/pre.yaml@master] 2025-12-01 09:30:46.209058 | 2025-12-01 09:30:46.209206 | PLAY [localhost] 2025-12-01 09:30:46.218071 | 2025-12-01 09:30:46.218161 | TASK [Gathering Facts] 2025-12-01 09:30:47.230932 | localhost | ok 2025-12-01 09:30:47.245823 | 2025-12-01 09:30:47.245909 | TASK [Setup log path fact] 2025-12-01 09:30:47.267791 | localhost | ok 2025-12-01 09:30:47.281246 | 2025-12-01 09:30:47.281327 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-12-01 09:30:47.309777 | localhost | ok 2025-12-01 09:30:47.318644 | 2025-12-01 09:30:47.318737 | TASK [emit-job-header : Print job information] 2025-12-01 09:30:47.349316 | # Job Information 2025-12-01 09:30:47.349498 | Ansible Version: 2.15.12 2025-12-01 09:30:47.349531 | Job: ansible-galaxy-importer 2025-12-01 09:30:47.349552 | Pipeline: third-party-check 2025-12-01 09:30:47.349570 | Executor: ze04.softwarefactory-project.io 2025-12-01 09:30:47.349588 | Triggered by: https://github.com/sap-linuxlab/community.sap_install/pull/1136 2025-12-01 09:30:47.349608 | Log URL (when completed): https://ansible.softwarefactory-project.io/logs/60b/ansible/60bce3c7c73a4ff79983ee6cc29dc135/ 2025-12-01 09:30:47.349627 | Event ID: 66f05c90-ce96-11f0-9ed4-1f959f746c97 2025-12-01 09:30:47.353819 | 2025-12-01 09:30:47.353890 | LOOP [emit-job-header : Print node information] 2025-12-01 09:30:47.461477 | localhost | ok: 2025-12-01 09:30:47.461915 | localhost | # Node Information 2025-12-01 09:30:47.461980 | localhost | Inventory Hostname: controller 2025-12-01 09:30:47.462024 | localhost | Hostname: np0005540859 2025-12-01 09:30:47.462066 | localhost | Username: zuul 2025-12-01 09:30:47.462111 | localhost | Distro: Fedora 37 2025-12-01 09:30:47.462151 | localhost | Provider: ansible-vexxhost-ca-ymq-1 2025-12-01 09:30:47.462324 | localhost | Region: ca-ymq-1 2025-12-01 09:30:47.462387 | localhost | Label: ansible-fedora-37-1vcpu 2025-12-01 09:30:47.462429 | localhost | Product Name: OpenStack Nova 2025-12-01 09:30:47.462468 | localhost | Interface IP: 162.253.55.227 2025-12-01 09:30:47.479067 | 2025-12-01 09:30:47.479257 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-12-01 09:30:47.901380 | localhost -> localhost | changed 2025-12-01 09:30:47.916572 | 2025-12-01 09:30:47.916752 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-12-01 09:30:48.864352 | localhost -> localhost | changed 2025-12-01 09:30:48.910203 | 2025-12-01 09:30:48.910652 | PLAY [all:!appliance*] 2025-12-01 09:30:48.941798 | 2025-12-01 09:30:48.941912 | TASK [include_role : start-zuul-console] 2025-12-01 09:30:48.965626 | controller | ok 2025-12-01 09:30:48.985670 | 2025-12-01 09:30:48.985781 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-12-01 09:30:49.393491 | controller | ok 2025-12-01 09:30:49.422498 | 2025-12-01 09:30:49.422658 | TASK [use-our-mirror : Retrieve the IP address] 2025-12-01 09:30:50.597584 | controller | ok: Status code was 404 and not [200]: HTTP Error 404: Not Found 2025-12-01 09:30:50.613905 | 2025-12-01 09:30:50.614051 | TASK [use-our-mirror : Ensure the registry service is running on the mirror] 2025-12-01 09:30:51.167448 | controller | skipping: Conditional result was False 2025-12-01 09:30:51.176641 | 2025-12-01 09:30:51.176780 | TASK [use-our-mirror : Write the IP in /etc/hosts] 2025-12-01 09:30:51.211861 | controller | skipping: Conditional result was False 2025-12-01 09:30:51.221117 | 2025-12-01 09:30:51.221212 | TASK [use-our-mirror : Create the podman configuration directory] 2025-12-01 09:30:51.247362 | controller | skipping: Conditional result was False 2025-12-01 09:30:51.256933 | 2025-12-01 09:30:51.257034 | TASK [use-our-mirror : Copy the podman configuration] 2025-12-01 09:30:51.282455 | controller | skipping: Conditional result was False 2025-12-01 09:30:51.292358 | 2025-12-01 09:30:51.292453 | TASK [use-our-mirror : Copy the Yum configuration (main)] 2025-12-01 09:30:51.319067 | controller | skipping: Conditional result was False 2025-12-01 09:30:51.330780 | 2025-12-01 09:30:51.330884 | TASK [use-our-mirror : Copy the Yum configuration (update)] 2025-12-01 09:30:51.357220 | controller | skipping: Conditional result was False 2025-12-01 09:30:51.375157 | 2025-12-01 09:30:51.375276 | TASK [Disable Fedora Modular] 2025-12-01 09:30:51.637084 | controller | changed 2025-12-01 09:30:51.651264 | 2025-12-01 09:30:51.651400 | TASK [Enable EPEL] 2025-12-01 09:30:51.678614 | controller | skipping: Conditional result was False 2025-12-01 09:30:51.693672 | 2025-12-01 09:30:51.693861 | TASK [Register the RHEL node] 2025-12-01 09:30:52.279472 | 2025-12-01 09:30:52.279784 | TASK [Show the subscription-manager status] 2025-12-01 09:30:52.865747 | controller | skipping: Conditional result was False 2025-12-01 09:30:52.883541 | 2025-12-01 09:30:52.883873 | TASK [Enable EPEL on RHEL] 2025-12-01 09:30:53.444017 | controller | skipping: Conditional result was False 2025-12-01 09:30:53.457795 | 2025-12-01 09:30:53.457957 | TASK [Install git and tox] 2025-12-01 09:32:13.547421 | controller | changed 2025-12-01 09:32:13.560565 | 2025-12-01 09:32:13.560726 | TASK [include_role : prepare-workspace] 2025-12-01 09:32:13.599800 | controller | ok 2025-12-01 09:32:13.637031 | 2025-12-01 09:32:13.637136 | TASK [prepare-workspace : Start zuul_console daemon.] 2025-12-01 09:32:13.902840 | controller | ok 2025-12-01 09:32:13.928612 | 2025-12-01 09:32:13.928846 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2025-12-01 09:32:15.175865 | controller | Output suppressed because no_log was given 2025-12-01 09:32:15.190838 | 2025-12-01 09:32:15.190944 | TASK [include_role : prepare-workspace-openshift] 2025-12-01 09:32:15.216879 | controller | skipping: Conditional result was False 2025-12-01 09:32:15.239108 | 2025-12-01 09:32:15.239242 | PLAY [all:!appliance] 2025-12-01 09:32:15.254419 | 2025-12-01 09:32:15.254494 | TASK [Run add-build-sshkey role (RSA)] 2025-12-01 09:32:15.276188 | controller | ok 2025-12-01 09:32:15.290573 | 2025-12-01 09:32:15.290659 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-12-01 09:32:15.518635 | controller -> localhost | ok 2025-12-01 09:32:15.533641 | 2025-12-01 09:32:15.533869 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-12-01 09:32:15.575598 | controller | ok 2025-12-01 09:32:15.590582 | controller | included: /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-12-01 09:32:15.596835 | 2025-12-01 09:32:15.596913 | TASK [add-build-sshkey : Create Temp SSH key] 2025-12-01 09:32:16.140394 | controller -> localhost | Generating public/private rsa key pair. 2025-12-01 09:32:16.140650 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/60bce3c7c73a4ff79983ee6cc29dc135_id_rsa. 2025-12-01 09:32:16.140721 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/60bce3c7c73a4ff79983ee6cc29dc135_id_rsa.pub. 2025-12-01 09:32:16.140754 | controller -> localhost | The key fingerprint is: 2025-12-01 09:32:16.140782 | controller -> localhost | SHA256:tv0bg0zmQtwS3lrmWg2b6jhnY9OASmc+VPOF234AwHQ zuul-build-sshkey 2025-12-01 09:32:16.140808 | controller -> localhost | The key's randomart image is: 2025-12-01 09:32:16.140833 | controller -> localhost | +---[RSA 2048]----+ 2025-12-01 09:32:16.140858 | controller -> localhost | | o. E | 2025-12-01 09:32:16.140884 | controller -> localhost | | o. | 2025-12-01 09:32:16.140908 | controller -> localhost | | .. . | 2025-12-01 09:32:16.140933 | controller -> localhost | | oo+o . | 2025-12-01 09:32:16.140956 | controller -> localhost | | oSoO= | 2025-12-01 09:32:16.140990 | controller -> localhost | | . =o.&o*o | 2025-12-01 09:32:16.141017 | controller -> localhost | | . * +oX.+. | 2025-12-01 09:32:16.141046 | controller -> localhost | | . +.*=...o. | 2025-12-01 09:32:16.141071 | controller -> localhost | | .B+o oo | 2025-12-01 09:32:16.141100 | controller -> localhost | +----[SHA256]-----+ 2025-12-01 09:32:16.141156 | controller -> localhost | ok: Runtime: 0:00:00.048001 2025-12-01 09:32:16.150080 | 2025-12-01 09:32:16.150165 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-12-01 09:32:16.184024 | controller | ok 2025-12-01 09:32:16.199389 | controller | included: /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-12-01 09:32:16.215221 | 2025-12-01 09:32:16.215312 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-12-01 09:32:16.241066 | controller | skipping: Conditional result was False 2025-12-01 09:32:16.285914 | 2025-12-01 09:32:16.286049 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-12-01 09:32:16.708329 | controller | changed 2025-12-01 09:32:16.721238 | 2025-12-01 09:32:16.721395 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-12-01 09:32:16.956122 | controller | ok 2025-12-01 09:32:16.968547 | 2025-12-01 09:32:16.968732 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-12-01 09:32:17.611952 | controller | changed 2025-12-01 09:32:17.624153 | 2025-12-01 09:32:17.624289 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-12-01 09:32:18.323762 | controller | changed 2025-12-01 09:32:18.336340 | 2025-12-01 09:32:18.336481 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-12-01 09:32:18.364027 | controller | skipping: Conditional result was False 2025-12-01 09:32:18.378929 | 2025-12-01 09:32:18.379073 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-12-01 09:32:18.795370 | controller -> localhost | changed 2025-12-01 09:32:18.807138 | 2025-12-01 09:32:18.807205 | TASK [add-build-sshkey : Add back temp key] 2025-12-01 09:32:19.095634 | controller -> localhost | Identity added: /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/60bce3c7c73a4ff79983ee6cc29dc135_id_rsa (zuul-build-sshkey) 2025-12-01 09:32:19.095908 | controller -> localhost | ok: Runtime: 0:00:00.007669 2025-12-01 09:32:19.102618 | 2025-12-01 09:32:19.102697 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-12-01 09:32:19.415289 | controller | ok 2025-12-01 09:32:19.427942 | 2025-12-01 09:32:19.428083 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-12-01 09:32:19.454949 | controller | skipping: Conditional result was False 2025-12-01 09:32:19.470984 | 2025-12-01 09:32:19.471094 | TASK [Run add-build-sshkey role (ECDSA)] 2025-12-01 09:32:19.510533 | controller | ok 2025-12-01 09:32:19.535019 | 2025-12-01 09:32:19.535107 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-12-01 09:32:19.777154 | controller -> localhost | ok 2025-12-01 09:32:19.785843 | 2025-12-01 09:32:19.785936 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-12-01 09:32:19.809593 | controller | ok 2025-12-01 09:32:19.824697 | controller | included: /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-12-01 09:32:19.833028 | 2025-12-01 09:32:19.833113 | TASK [add-build-sshkey : Create Temp SSH key] 2025-12-01 09:32:20.122054 | controller -> localhost | Generating public/private ecdsa key pair. 2025-12-01 09:32:20.122298 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/60bce3c7c73a4ff79983ee6cc29dc135_id_ecdsa. 2025-12-01 09:32:20.122327 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/60bce3c7c73a4ff79983ee6cc29dc135_id_ecdsa.pub. 2025-12-01 09:32:20.122356 | controller -> localhost | The key fingerprint is: 2025-12-01 09:32:20.122376 | controller -> localhost | SHA256:vHS5NV+pz3X5Ezr+tMjexH5Zvmn0L0dj0qZ7lmEEsh0 zuul-build-sshkey 2025-12-01 09:32:20.122398 | controller -> localhost | The key's randomart image is: 2025-12-01 09:32:20.122417 | controller -> localhost | +---[ECDSA 521]---+ 2025-12-01 09:32:20.122435 | controller -> localhost | | | 2025-12-01 09:32:20.122453 | controller -> localhost | | . E | 2025-12-01 09:32:20.122471 | controller -> localhost | | + o | 2025-12-01 09:32:20.122488 | controller -> localhost | | . o . ..| 2025-12-01 09:32:20.122505 | controller -> localhost | | S o o o..| 2025-12-01 09:32:20.122523 | controller -> localhost | | . o o +o@+| 2025-12-01 09:32:20.122539 | controller -> localhost | | . . .XB@| 2025-12-01 09:32:20.122556 | controller -> localhost | | .+XB@| 2025-12-01 09:32:20.122573 | controller -> localhost | | o*B%B| 2025-12-01 09:32:20.122592 | controller -> localhost | +----[SHA256]-----+ 2025-12-01 09:32:20.122655 | controller -> localhost | ok: Runtime: 0:00:00.010651 2025-12-01 09:32:20.129740 | 2025-12-01 09:32:20.129805 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-12-01 09:32:20.173068 | controller | ok 2025-12-01 09:32:20.183185 | controller | included: /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-12-01 09:32:20.195734 | 2025-12-01 09:32:20.195819 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-12-01 09:32:20.221639 | controller | skipping: Conditional result was False 2025-12-01 09:32:20.228864 | 2025-12-01 09:32:20.228927 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-12-01 09:32:20.509460 | controller | changed 2025-12-01 09:32:20.524740 | 2025-12-01 09:32:20.524911 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-12-01 09:32:20.760740 | controller | ok 2025-12-01 09:32:20.773372 | 2025-12-01 09:32:20.773511 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-12-01 09:32:21.786137 | controller | changed 2025-12-01 09:32:21.794601 | 2025-12-01 09:32:21.794744 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-12-01 09:32:22.406330 | controller | changed 2025-12-01 09:32:22.412180 | 2025-12-01 09:32:22.412248 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-12-01 09:32:22.446835 | controller | skipping: Conditional result was False 2025-12-01 09:32:22.456427 | 2025-12-01 09:32:22.456553 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-12-01 09:32:22.728031 | controller -> localhost | changed 2025-12-01 09:32:22.739821 | 2025-12-01 09:32:22.739912 | TASK [add-build-sshkey : Add back temp key] 2025-12-01 09:32:23.062585 | controller -> localhost | Identity added: /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/60bce3c7c73a4ff79983ee6cc29dc135_id_ecdsa (zuul-build-sshkey) 2025-12-01 09:32:23.062971 | controller -> localhost | ok: Runtime: 0:00:00.010900 2025-12-01 09:32:23.086905 | 2025-12-01 09:32:23.087006 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-12-01 09:32:23.314257 | controller | ok 2025-12-01 09:32:23.329838 | 2025-12-01 09:32:23.330010 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-12-01 09:32:23.387331 | controller | skipping: Conditional result was False 2025-12-01 09:32:23.403190 | 2025-12-01 09:32:23.403281 | TASK [include_role : remove-zuul-sshkey] 2025-12-01 09:32:23.428595 | controller | skipping: Conditional result was False 2025-12-01 09:32:23.439256 | 2025-12-01 09:32:23.439356 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2025-12-01 09:32:23.671836 | controller | ok: "logs" 2025-12-01 09:32:23.672140 | controller | ok: All items complete 2025-12-01 09:32:23.672178 | 2025-12-01 09:32:23.872996 | controller | ok: "artifacts" 2025-12-01 09:32:24.094002 | controller | ok: "docs" 2025-12-01 09:32:24.110436 | 2025-12-01 09:32:24.110606 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2025-12-01 09:32:24.352542 | controller | changed: "logs" 2025-12-01 09:32:24.534954 | controller | changed: "artifacts" 2025-12-01 09:32:24.715657 | controller | changed: "docs" 2025-12-01 09:32:24.814596 | 2025-12-01 09:32:24.814715 | PLAY RECAP 2025-12-01 09:32:24.814759 | controller | ok: 30 changed: 16 unreachable: 0 failed: 0 skipped: 18 rescued: 0 ignored: 0 2025-12-01 09:32:24.814784 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-12-01 09:32:24.814803 | 2025-12-01 09:32:24.957170 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/ansible/zuul-config/playbooks/base/pre.yaml@master] 2025-12-01 09:32:24.958601 | PRE-RUN START: [untrusted : github.com/ansible/ansible-zuul-jobs/playbooks/ansible-galaxy-importer/pre.yaml@master] 2025-12-01 09:32:25.566874 | 2025-12-01 09:32:25.566993 | PLAY [all] 2025-12-01 09:32:25.587426 | 2025-12-01 09:32:25.587502 | TASK [Setup ensure-tox role] 2025-12-01 09:32:25.606802 | controller | ok 2025-12-01 09:32:25.629645 | 2025-12-01 09:32:25.629737 | TASK [Install pip] 2025-12-01 09:32:25.648621 | controller | ok 2025-12-01 09:32:25.669646 | 2025-12-01 09:32:25.669732 | TASK [ensure-pip : Check if pip is installed] 2025-12-01 09:32:26.070102 | controller | /usr/bin/pip3 2025-12-01 09:32:26.085018 | controller | /usr/bin/python3: No module named wheel 2025-12-01 09:32:26.200733 | controller | ok: Runtime: 0:00:00.022359 2025-12-01 09:32:26.213095 | 2025-12-01 09:32:26.213234 | LOOP [ensure-pip : Install pip from packages] 2025-12-01 09:32:26.262798 | controller | ok: "/var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/untrusted/project_2/opendev.org/zuul/zuul-jobs/roles/ensure-pip/tasks/RedHat.yaml" 2025-12-01 09:32:26.282793 | controller | included: /var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/untrusted/project_2/opendev.org/zuul/zuul-jobs/roles/ensure-pip/tasks/RedHat.yaml 2025-12-01 09:32:26.305723 | 2025-12-01 09:32:26.305889 | TASK [ensure-pip : Install Python 3 pip] 2025-12-01 09:32:31.140591 | controller | changed 2025-12-01 09:32:31.154832 | 2025-12-01 09:32:31.154995 | TASK [ensure-pip : Check for EPEL repository] 2025-12-01 09:32:31.173746 | controller | skipping: Conditional result was False 2025-12-01 09:32:31.188660 | 2025-12-01 09:32:31.188877 | TASK [ensure-pip : Fail with instructions when EPEL is not installed] 2025-12-01 09:32:31.207850 | controller | skipping: Conditional result was False 2025-12-01 09:32:31.223227 | 2025-12-01 09:32:31.223384 | TASK [ensure-pip : Install Python 2 pip] 2025-12-01 09:32:31.241473 | controller | skipping: Conditional result was False 2025-12-01 09:32:31.250703 | 2025-12-01 09:32:31.250798 | TASK [ensure-pip : Ensure setuptools] 2025-12-01 09:32:31.276389 | controller | skipping: Conditional result was False 2025-12-01 09:32:31.286546 | 2025-12-01 09:32:31.286641 | TASK [ensure-pip : Check for ensurepip module] 2025-12-01 09:32:31.831328 | controller | skipping: Conditional result was False 2025-12-01 09:32:31.845817 | 2025-12-01 09:32:31.845969 | TASK [ensure-pip : Ensure python3-venv] 2025-12-01 09:32:31.873489 | controller | skipping: Conditional result was False 2025-12-01 09:32:31.887443 | 2025-12-01 09:32:31.887591 | TASK [ensure-pip : Install pip from source] 2025-12-01 09:32:31.914845 | controller | skipping: Conditional result was False 2025-12-01 09:32:31.927983 | 2025-12-01 09:32:31.928120 | TASK [ensure-pip : Probe for venv python full path] 2025-12-01 09:32:32.270139 | controller | /usr/bin/python3 2025-12-01 09:32:32.480816 | controller | ok: Runtime: 0:00:00.003499 2025-12-01 09:32:32.533912 | 2025-12-01 09:32:32.534093 | TASK [ensure-pip : Set host default] 2025-12-01 09:32:32.599303 | controller | ok 2025-12-01 09:32:32.609219 | 2025-12-01 09:32:32.609499 | TASK [ensure-pip : Set ensure_pip_virtualenv_command] 2025-12-01 09:32:32.674225 | controller | ok 2025-12-01 09:32:32.685521 | 2025-12-01 09:32:32.685585 | TASK [ensure-tox : Check if tox is installed] 2025-12-01 09:32:32.909448 | controller | /usr/bin/tox 2025-12-01 09:32:33.219787 | controller | ok: Runtime: 0:00:00.003240 2025-12-01 09:32:33.232099 | 2025-12-01 09:32:33.232237 | TASK [ensure-tox : Export preinstalled tox_exectuable] 2025-12-01 09:32:33.282804 | controller | ok 2025-12-01 09:32:33.294116 | 2025-12-01 09:32:33.294247 | TASK [ensure-tox : Create local venv] 2025-12-01 09:32:33.847361 | controller | skipping: Conditional result was False 2025-12-01 09:32:33.854142 | 2025-12-01 09:32:33.854212 | TASK [ensure-tox : Install tox to local venv] 2025-12-01 09:32:34.418496 | controller | skipping: Conditional result was False 2025-12-01 09:32:34.427378 | 2025-12-01 09:32:34.427473 | TASK [ensure-tox : Export installed tox_executable path] 2025-12-01 09:32:34.452968 | controller | skipping: Conditional result was False 2025-12-01 09:32:34.462393 | 2025-12-01 09:32:34.462487 | TASK [ensure-tox : Output tox version] 2025-12-01 09:32:34.837774 | controller | 3.28.0 imported from /usr/lib/python3.11/site-packages/tox/__init__.py 2025-12-01 09:32:35.008097 | controller | ok: Runtime: 0:00:00.139806 2025-12-01 09:32:35.017170 | 2025-12-01 09:32:35.017277 | TASK [ensure-tox : Make global symlink] 2025-12-01 09:32:35.058926 | controller | skipping: Conditional result was False 2025-12-01 09:32:35.088806 | 2025-12-01 09:32:35.089094 | TASK [Setup tox role] 2025-12-01 09:32:35.117819 | controller | ok 2025-12-01 09:32:35.165472 | 2025-12-01 09:32:35.165656 | TASK [tox : Check to see if the constraints file exists] 2025-12-01 09:32:35.191440 | controller | skipping: Conditional result was False 2025-12-01 09:32:35.200419 | 2025-12-01 09:32:35.200516 | TASK [tox : Fail if constraints file is missing] 2025-12-01 09:32:35.226026 | controller | skipping: Conditional result was False 2025-12-01 09:32:35.234165 | 2025-12-01 09:32:35.234256 | TASK [tox : Record file location] 2025-12-01 09:32:35.259481 | controller | skipping: Conditional result was False 2025-12-01 09:32:35.267924 | 2025-12-01 09:32:35.268011 | TASK [tox : Install tox siblings] 2025-12-01 09:32:35.282970 | controller | skipping: Conditional result was False 2025-12-01 09:32:35.292559 | 2025-12-01 09:32:35.292647 | TASK [tox : Emit tox command] 2025-12-01 09:32:35.328136 | /usr/bin/tox -evenv -vv --notest 2025-12-01 09:32:35.335355 | 2025-12-01 09:32:35.335442 | TASK [tox : Run tox] 2025-12-01 09:32:35.718589 | controller | using tox.ini: /home/zuul/src/github.com/ansible-network/releases/tox.ini (pid 2277) 2025-12-01 09:32:35.725744 | controller | using tox-3.28.0 from /usr/lib/python3.11/site-packages/tox/__init__.py (pid 2277) 2025-12-01 09:32:35.747460 | controller | skipping sdist step 2025-12-01 09:32:35.747477 | controller | venv uses /usr/bin/python3 2025-12-01 09:32:35.747495 | controller | venv start: getenv /home/zuul/src/github.com/ansible-network/releases/.tox/venv 2025-12-01 09:32:35.747670 | controller | venv cannot reuse: no previous config /home/zuul/src/github.com/ansible-network/releases/.tox/venv/.tox-config1 2025-12-01 09:32:35.747682 | controller | venv create: /home/zuul/src/github.com/ansible-network/releases/.tox/venv 2025-12-01 09:32:35.747690 | controller | setting PATH=/home/zuul/src/github.com/ansible-network/releases/.tox/venv/bin:/home/zuul/.local/bin:/home/zuul/bin:/usr/local/bin:/usr/bin:/usr/local/sbin:/usr/sbin 2025-12-01 09:32:35.747699 | controller | [2285] /home/zuul/src/github.com/ansible-network/releases/.tox$ /usr/bin/python3 -m virtualenv --no-download --python /usr/bin/python3 venv 2025-12-01 09:32:36.257924 | controller | created virtual environment CPython3.11.0.final.0-64 in 430ms 2025-12-01 09:32:36.283791 | controller | creator CPython3Posix(dest=/home/zuul/src/github.com/ansible-network/releases/.tox/venv, clear=False, no_vcs_ignore=False, global=False) 2025-12-01 09:32:36.283821 | controller | seeder FromAppData(extra_search_dir=/usr/share/python-wheels,download=False, pip=bundle, setuptools=bundle, wheel=bundle, via=copy, app_data_dir=/home/zuul/.local/share/virtualenv) 2025-12-01 09:32:36.283830 | controller | added seed packages: pip==22.2.2, setuptools==62.6.0, wheel==0.37.1 2025-12-01 09:32:36.283834 | controller | activators BashActivator,CShellActivator,FishActivator,NushellActivator,PowerShellActivator,PythonActivator 2025-12-01 09:32:36.283845 | controller | venv installdeps: -r/home/zuul/src/github.com/ansible-network/releases/requirements.txt, -r/home/zuul/src/github.com/ansible-network/releases/test-requirements.txt 2025-12-01 09:32:36.283918 | controller | setting PATH=/home/zuul/src/github.com/ansible-network/releases/.tox/venv/bin:/home/zuul/.local/bin:/home/zuul/bin:/usr/local/bin:/usr/bin:/usr/local/sbin:/usr/sbin 2025-12-01 09:32:36.283931 | controller | [2293] /home/zuul/src/github.com/ansible-network/releases$ /home/zuul/src/github.com/ansible-network/releases/.tox/venv/bin/pip install -r/home/zuul/src/github.com/ansible-network/releases/requirements.txt -r/home/zuul/src/github.com/ansible-network/releases/test-requirements.txt 2025-12-01 09:37:13.814629 | [Zuul] Log Stream did not terminate 2025-12-01 09:37:13.815660 | controller | ERROR 2025-12-01 09:37:13.815877 | controller | { 2025-12-01 09:37:13.815938 | controller | "msg": "Data could not be sent to remote host \"162.253.55.227\". Make sure this host can be reached over ssh: ssh: connect to host 162.253.55.227 port 22: No route to host\r\n", 2025-12-01 09:37:13.815981 | controller | "unreachable": true 2025-12-01 09:37:13.816019 | controller | } unreachable 2025-12-01 09:37:13.819271 | 2025-12-01 09:37:13.819429 | PLAY RECAP 2025-12-01 09:37:13.819512 | controller | ok: 10 changed: 5 unreachable: 1 failed: 0 skipped: 15 rescued: 0 ignored: 0 2025-12-01 09:37:13.819555 | 2025-12-01 09:37:13.943039 | PRE-RUN END RESULT_UNREACHABLE: [untrusted : github.com/ansible/ansible-zuul-jobs/playbooks/ansible-galaxy-importer/pre.yaml@master] 2025-12-01 09:37:13.944716 | POST-RUN START: [trusted : github.com/ansible/zuul-config/playbooks/base/post.yaml@master] 2025-12-01 09:37:14.571904 | 2025-12-01 09:37:14.572041 | PLAY [all:!appliance*] 2025-12-01 09:37:14.601753 | 2025-12-01 09:37:14.601866 | TASK [unregister the node] 2025-12-01 09:37:17.002322 | [controller] Waiting on logger 2025-12-01 09:37:37.109173 | controller | skipping: Conditional result was False 2025-12-01 09:37:37.117359 | 2025-12-01 09:37:37.117459 | TASK [include_role : fetch-output] 2025-12-01 09:37:37.159654 | controller | ok 2025-12-01 09:37:37.187236 | 2025-12-01 09:37:37.187351 | TASK [fetch-output : Set log path for multiple nodes] 2025-12-01 09:37:37.262342 | controller | skipping: Conditional result was False 2025-12-01 09:37:37.270852 | 2025-12-01 09:37:37.270944 | TASK [fetch-output : Set log path for single node] 2025-12-01 09:37:37.328627 | controller | ok 2025-12-01 09:37:37.340955 | 2025-12-01 09:37:37.341095 | LOOP [fetch-output : Ensure local output dirs] 2025-12-01 09:37:37.789957 | controller -> localhost | ok: "/var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/logs" 2025-12-01 09:37:38.057182 | controller -> localhost | changed: "/var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/artifacts" 2025-12-01 09:37:38.280508 | controller -> localhost | changed: "/var/lib/zuul/builds/60bce3c7c73a4ff79983ee6cc29dc135/work/docs" 2025-12-01 09:37:38.306209 | 2025-12-01 09:37:38.306406 | LOOP [fetch-output : Collect logs, artifacts and docs] 2025-12-01 09:37:39.026441 | controller | ok 2025-12-01 09:37:39.026671 | controller | changed: All items complete 2025-12-01 09:37:39.026718 | 2025-12-01 09:37:39.552049 | controller | changed: .d..t...... ./ 2025-12-01 09:37:40.028767 | controller | changed: .d..t...... ./ 2025-12-01 09:37:40.051442 | 2025-12-01 09:37:40.051571 | TASK [include_role : fetch-output-openshift] 2025-12-01 09:37:40.065858 | controller | skipping: Conditional result was False 2025-12-01 09:37:40.072848 | 2025-12-01 09:37:40.072913 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2025-12-01 09:37:40.471152 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.012674 2025-12-01 09:37:40.729739 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.011980 2025-12-01 09:37:40.766503 | 2025-12-01 09:37:40.766610 | PLAY [localhost] 2025-12-01 09:37:40.779204 | 2025-12-01 09:37:40.779264 | TASK [Run Zuul manifest role] 2025-12-01 09:37:40.797133 | localhost | ok 2025-12-01 09:37:40.811714 | 2025-12-01 09:37:40.811788 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2025-12-01 09:37:41.241204 | localhost | changed 2025-12-01 09:37:41.251266 | 2025-12-01 09:37:41.251402 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2025-12-01 09:37:41.297833 | localhost | ok 2025-12-01 09:37:41.316357 | 2025-12-01 09:37:41.316486 | TASK [Set zuul-log-path fact] 2025-12-01 09:37:41.339014 | localhost | ok 2025-12-01 09:37:41.357083 | 2025-12-01 09:37:41.357170 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-12-01 09:37:41.397517 | localhost | ok 2025-12-01 09:37:41.410190 | 2025-12-01 09:37:41.410267 | LOOP [Run upload-logs-swift role] 2025-12-01 09:37:41.457626 | localhost | Output suppressed because no_log was given 2025-12-01 09:37:41.507629 | 2025-12-01 09:37:41.507780 | TASK [Set zuul-log-path fact] 2025-12-01 09:37:41.584409 | localhost | skipping: Conditional result was False 2025-12-01 09:37:41.633102 | 2025-12-01 09:37:41.633268 | TASK [upload-logs-swift : Ensure logs are readable before uploading] 2025-12-01 09:37:41.913361 | localhost -> localhost | ok: Runtime: 0:00:00.008548 2025-12-01 09:37:41.924943 | 2025-12-01 09:37:41.925077 | TASK [upload-logs-swift : Upload logs to swift]