2025-11-19 05:46:20.802367 | Job console starting... 2025-11-19 05:46:20.815278 | Updating repositories 2025-11-19 05:46:21.518849 | Preparing job workspace 2025-11-19 05:46:25.415218 | Running Ansible setup... 2025-11-19 05:46:30.162217 | PRE-RUN START: [trusted : github.com/ansible/zuul-config/playbooks/base/pre.yaml@master] 2025-11-19 05:46:30.757060 | 2025-11-19 05:46:30.757166 | PLAY [localhost] 2025-11-19 05:46:30.765507 | 2025-11-19 05:46:30.765577 | TASK [Gathering Facts] 2025-11-19 05:46:31.812464 | localhost | ok 2025-11-19 05:46:31.839657 | 2025-11-19 05:46:31.839856 | TASK [Setup log path fact] 2025-11-19 05:46:31.865328 | localhost | ok 2025-11-19 05:46:31.889612 | 2025-11-19 05:46:31.889735 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-11-19 05:46:31.920194 | localhost | ok 2025-11-19 05:46:31.931328 | 2025-11-19 05:46:31.931418 | TASK [emit-job-header : Print job information] 2025-11-19 05:46:31.962722 | # Job Information 2025-11-19 05:46:31.962878 | Ansible Version: 2.15.12 2025-11-19 05:46:31.962920 | Job: ansible-galaxy-importer 2025-11-19 05:46:31.962948 | Pipeline: third-party-check 2025-11-19 05:46:31.962972 | Executor: ze01.softwarefactory-project.io 2025-11-19 05:46:31.962996 | Triggered by: https://github.com/ansible-collections/community.mongodb/pull/725 2025-11-19 05:46:31.963050 | Log URL (when completed): https://ansible.softwarefactory-project.io/logs/174/ansible/174321edcac646e0b44d4ed942c5c9fb/ 2025-11-19 05:46:31.963080 | Event ID: 0509d9e0-c507-11f0-81ac-d888f35f6270 2025-11-19 05:46:31.968192 | 2025-11-19 05:46:31.968292 | LOOP [emit-job-header : Print node information] 2025-11-19 05:46:32.067612 | localhost | ok: 2025-11-19 05:46:32.068107 | localhost | # Node Information 2025-11-19 05:46:32.068175 | localhost | Inventory Hostname: controller 2025-11-19 05:46:32.068221 | localhost | Hostname: np0005527500 2025-11-19 05:46:32.068264 | localhost | Username: zuul 2025-11-19 05:46:32.068310 | localhost | Distro: Fedora 37 2025-11-19 05:46:32.068350 | localhost | Provider: ansible-vexxhost-ca-ymq-1 2025-11-19 05:46:32.068389 | localhost | Region: ca-ymq-1 2025-11-19 05:46:32.068427 | localhost | Label: ansible-fedora-37-1vcpu 2025-11-19 05:46:32.068465 | localhost | Product Name: OpenStack Nova 2025-11-19 05:46:32.068504 | localhost | Interface IP: 162.253.55.213 2025-11-19 05:46:32.093346 | 2025-11-19 05:46:32.093598 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-11-19 05:46:32.518729 | localhost -> localhost | changed 2025-11-19 05:46:32.530760 | 2025-11-19 05:46:32.530903 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-11-19 05:46:33.426149 | localhost -> localhost | changed 2025-11-19 05:46:33.467222 | 2025-11-19 05:46:33.467390 | PLAY [all:!appliance*] 2025-11-19 05:46:33.498135 | 2025-11-19 05:46:33.498221 | TASK [include_role : start-zuul-console] 2025-11-19 05:46:33.519741 | controller | ok 2025-11-19 05:46:33.537922 | 2025-11-19 05:46:33.538005 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-11-19 05:46:33.931334 | controller | ok 2025-11-19 05:46:33.954836 | 2025-11-19 05:46:33.954973 | TASK [use-our-mirror : Retrieve the IP address] 2025-11-19 05:46:35.024174 | controller | ok: Status code was 404 and not [200]: HTTP Error 404: Not Found 2025-11-19 05:46:35.037645 | 2025-11-19 05:46:35.037770 | TASK [use-our-mirror : Ensure the registry service is running on the mirror] 2025-11-19 05:46:35.585132 | controller | skipping: Conditional result was False 2025-11-19 05:46:35.598475 | 2025-11-19 05:46:35.598630 | TASK [use-our-mirror : Write the IP in /etc/hosts] 2025-11-19 05:46:35.624856 | controller | skipping: Conditional result was False 2025-11-19 05:46:35.637614 | 2025-11-19 05:46:35.637745 | TASK [use-our-mirror : Create the podman configuration directory] 2025-11-19 05:46:35.664136 | controller | skipping: Conditional result was False 2025-11-19 05:46:35.676586 | 2025-11-19 05:46:35.676726 | TASK [use-our-mirror : Copy the podman configuration] 2025-11-19 05:46:35.703457 | controller | skipping: Conditional result was False 2025-11-19 05:46:35.717141 | 2025-11-19 05:46:35.717311 | TASK [use-our-mirror : Copy the Yum configuration (main)] 2025-11-19 05:46:35.744119 | controller | skipping: Conditional result was False 2025-11-19 05:46:35.756914 | 2025-11-19 05:46:35.757112 | TASK [use-our-mirror : Copy the Yum configuration (update)] 2025-11-19 05:46:35.784095 | controller | skipping: Conditional result was False 2025-11-19 05:46:35.810908 | 2025-11-19 05:46:35.811108 | TASK [Disable Fedora Modular] 2025-11-19 05:46:36.098242 | controller | changed 2025-11-19 05:46:36.106343 | 2025-11-19 05:46:36.106429 | TASK [Enable EPEL] 2025-11-19 05:46:36.132119 | controller | skipping: Conditional result was False 2025-11-19 05:46:36.141276 | 2025-11-19 05:46:36.141367 | TASK [Register the RHEL node] 2025-11-19 05:46:36.694836 | 2025-11-19 05:46:36.695155 | TASK [Show the subscription-manager status] 2025-11-19 05:46:37.278207 | controller | skipping: Conditional result was False 2025-11-19 05:46:37.292131 | 2025-11-19 05:46:37.292260 | TASK [Enable EPEL on RHEL] 2025-11-19 05:46:37.849833 | controller | skipping: Conditional result was False 2025-11-19 05:46:37.857570 | 2025-11-19 05:46:37.857658 | TASK [Install git and tox] 2025-11-19 05:47:59.440526 | controller | changed 2025-11-19 05:47:59.453963 | 2025-11-19 05:47:59.454137 | TASK [include_role : prepare-workspace] 2025-11-19 05:47:59.491658 | controller | ok 2025-11-19 05:47:59.527614 | 2025-11-19 05:47:59.527710 | TASK [prepare-workspace : Start zuul_console daemon.] 2025-11-19 05:47:59.760762 | controller | ok 2025-11-19 05:47:59.767628 | 2025-11-19 05:47:59.767686 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2025-11-19 05:48:00.808441 | controller | Output suppressed because no_log was given 2025-11-19 05:48:00.831273 | 2025-11-19 05:48:00.831409 | TASK [include_role : prepare-workspace-openshift] 2025-11-19 05:48:00.858791 | controller | skipping: Conditional result was False 2025-11-19 05:48:00.887583 | 2025-11-19 05:48:00.887661 | PLAY [all:!appliance] 2025-11-19 05:48:00.909957 | 2025-11-19 05:48:00.910073 | TASK [Run add-build-sshkey role (RSA)] 2025-11-19 05:48:00.942132 | controller | ok 2025-11-19 05:48:00.961640 | 2025-11-19 05:48:00.961723 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-11-19 05:48:01.230777 | controller -> localhost | ok 2025-11-19 05:48:01.237330 | 2025-11-19 05:48:01.237391 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-11-19 05:48:01.267861 | controller | ok 2025-11-19 05:48:01.281149 | controller | included: /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-11-19 05:48:01.286792 | 2025-11-19 05:48:01.286849 | TASK [add-build-sshkey : Create Temp SSH key] 2025-11-19 05:48:01.786467 | controller -> localhost | Generating public/private rsa key pair. 2025-11-19 05:48:01.786740 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/174321edcac646e0b44d4ed942c5c9fb_id_rsa. 2025-11-19 05:48:01.786768 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/174321edcac646e0b44d4ed942c5c9fb_id_rsa.pub. 2025-11-19 05:48:01.786789 | controller -> localhost | The key fingerprint is: 2025-11-19 05:48:01.786808 | controller -> localhost | SHA256:LX+z8/GVsDutrIuFb2ZLOsX+FinbXuIvK9xhYOiGj0c zuul-build-sshkey 2025-11-19 05:48:01.786829 | controller -> localhost | The key's randomart image is: 2025-11-19 05:48:01.786847 | controller -> localhost | +---[RSA 2048]----+ 2025-11-19 05:48:01.786865 | controller -> localhost | | | 2025-11-19 05:48:01.786883 | controller -> localhost | | | 2025-11-19 05:48:01.786900 | controller -> localhost | | . | 2025-11-19 05:48:01.786917 | controller -> localhost | | o o | 2025-11-19 05:48:01.786934 | controller -> localhost | | S + ... | 2025-11-19 05:48:01.786957 | controller -> localhost | | . E.+ =o .| 2025-11-19 05:48:01.786980 | controller -> localhost | | =.=oOo=o.| 2025-11-19 05:48:01.787001 | controller -> localhost | | . +*X+O++.| 2025-11-19 05:48:01.787037 | controller -> localhost | | .o==X@B..| 2025-11-19 05:48:01.787062 | controller -> localhost | +----[SHA256]-----+ 2025-11-19 05:48:01.787105 | controller -> localhost | ok: Runtime: 0:00:00.060976 2025-11-19 05:48:01.793613 | 2025-11-19 05:48:01.793672 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-11-19 05:48:01.825467 | controller | ok 2025-11-19 05:48:01.860490 | controller | included: /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-11-19 05:48:01.869007 | 2025-11-19 05:48:01.869102 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-11-19 05:48:01.893123 | controller | skipping: Conditional result was False 2025-11-19 05:48:01.899795 | 2025-11-19 05:48:01.899860 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-11-19 05:48:02.293820 | controller | changed 2025-11-19 05:48:02.299379 | 2025-11-19 05:48:02.299438 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-11-19 05:48:02.532221 | controller | ok 2025-11-19 05:48:02.537697 | 2025-11-19 05:48:02.537757 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-11-19 05:48:03.160906 | controller | changed 2025-11-19 05:48:03.173934 | 2025-11-19 05:48:03.174100 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-11-19 05:48:03.835521 | controller | changed 2025-11-19 05:48:03.847978 | 2025-11-19 05:48:03.848161 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-11-19 05:48:03.875213 | controller | skipping: Conditional result was False 2025-11-19 05:48:03.889058 | 2025-11-19 05:48:03.889197 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-11-19 05:48:04.283308 | controller -> localhost | changed 2025-11-19 05:48:04.307492 | 2025-11-19 05:48:04.307625 | TASK [add-build-sshkey : Add back temp key] 2025-11-19 05:48:04.640563 | controller -> localhost | Identity added: /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/174321edcac646e0b44d4ed942c5c9fb_id_rsa (zuul-build-sshkey) 2025-11-19 05:48:04.640831 | controller -> localhost | ok: Runtime: 0:00:00.013706 2025-11-19 05:48:04.648366 | 2025-11-19 05:48:04.648426 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-11-19 05:48:04.969889 | controller | ok 2025-11-19 05:48:04.981710 | 2025-11-19 05:48:04.981838 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-11-19 05:48:05.019924 | controller | skipping: Conditional result was False 2025-11-19 05:48:05.044088 | 2025-11-19 05:48:05.044223 | TASK [Run add-build-sshkey role (ECDSA)] 2025-11-19 05:48:05.082718 | controller | ok 2025-11-19 05:48:05.113658 | 2025-11-19 05:48:05.113750 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-11-19 05:48:05.393839 | controller -> localhost | ok 2025-11-19 05:48:05.407211 | 2025-11-19 05:48:05.407343 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-11-19 05:48:05.445969 | controller | ok 2025-11-19 05:48:05.468858 | controller | included: /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-11-19 05:48:05.479902 | 2025-11-19 05:48:05.479981 | TASK [add-build-sshkey : Create Temp SSH key] 2025-11-19 05:48:05.820424 | controller -> localhost | Generating public/private ecdsa key pair. 2025-11-19 05:48:05.820711 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/174321edcac646e0b44d4ed942c5c9fb_id_ecdsa. 2025-11-19 05:48:05.820769 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/174321edcac646e0b44d4ed942c5c9fb_id_ecdsa.pub. 2025-11-19 05:48:05.820826 | controller -> localhost | The key fingerprint is: 2025-11-19 05:48:05.820870 | controller -> localhost | SHA256:Y7RA2ApHtQmfbQnbs2yasLQw0A3tXB3P82JSWCnsn+4 zuul-build-sshkey 2025-11-19 05:48:05.820911 | controller -> localhost | The key's randomart image is: 2025-11-19 05:48:05.820950 | controller -> localhost | +---[ECDSA 521]---+ 2025-11-19 05:48:05.820989 | controller -> localhost | | .oo++o.... | 2025-11-19 05:48:05.821068 | controller -> localhost | | ..o++oO+*. | 2025-11-19 05:48:05.821113 | controller -> localhost | |. .=.oB.O.= | 2025-11-19 05:48:05.821152 | controller -> localhost | | . + =.= o | 2025-11-19 05:48:05.821190 | controller -> localhost | | o o S.o.. | 2025-11-19 05:48:05.821228 | controller -> localhost | | + + = +o. | 2025-11-19 05:48:05.821266 | controller -> localhost | | o o . | 2025-11-19 05:48:05.821303 | controller -> localhost | | . | 2025-11-19 05:48:05.821340 | controller -> localhost | | .E | 2025-11-19 05:48:05.821377 | controller -> localhost | +----[SHA256]-----+ 2025-11-19 05:48:05.821467 | controller -> localhost | ok: Runtime: 0:00:00.013640 2025-11-19 05:48:05.835369 | 2025-11-19 05:48:05.835494 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-11-19 05:48:05.873666 | controller | ok 2025-11-19 05:48:05.889317 | controller | included: /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-11-19 05:48:05.904875 | 2025-11-19 05:48:05.904953 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-11-19 05:48:05.929932 | controller | skipping: Conditional result was False 2025-11-19 05:48:05.944953 | 2025-11-19 05:48:05.945129 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-11-19 05:48:06.229279 | controller | changed 2025-11-19 05:48:06.241478 | 2025-11-19 05:48:06.241600 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-11-19 05:48:06.474260 | controller | ok 2025-11-19 05:48:06.486431 | 2025-11-19 05:48:06.486554 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-11-19 05:48:07.121240 | controller | changed 2025-11-19 05:48:07.128821 | 2025-11-19 05:48:07.128902 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-11-19 05:48:07.775531 | controller | changed 2025-11-19 05:48:07.788000 | 2025-11-19 05:48:07.788177 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-11-19 05:48:07.815131 | controller | skipping: Conditional result was False 2025-11-19 05:48:07.828724 | 2025-11-19 05:48:07.828861 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-11-19 05:48:08.112475 | controller -> localhost | changed 2025-11-19 05:48:08.136384 | 2025-11-19 05:48:08.136536 | TASK [add-build-sshkey : Add back temp key] 2025-11-19 05:48:08.482445 | controller -> localhost | Identity added: /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/174321edcac646e0b44d4ed942c5c9fb_id_ecdsa (zuul-build-sshkey) 2025-11-19 05:48:08.482704 | controller -> localhost | ok: Runtime: 0:00:00.013187 2025-11-19 05:48:08.491897 | 2025-11-19 05:48:08.491993 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-11-19 05:48:08.732088 | controller | ok 2025-11-19 05:48:08.744668 | 2025-11-19 05:48:08.744804 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-11-19 05:48:08.783340 | controller | skipping: Conditional result was False 2025-11-19 05:48:08.811577 | 2025-11-19 05:48:08.811728 | TASK [include_role : remove-zuul-sshkey] 2025-11-19 05:48:08.838823 | controller | skipping: Conditional result was False 2025-11-19 05:48:08.847769 | 2025-11-19 05:48:08.847864 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2025-11-19 05:48:09.104904 | controller | ok: "logs" 2025-11-19 05:48:09.105554 | controller | ok: All items complete 2025-11-19 05:48:09.105646 | 2025-11-19 05:48:09.299374 | controller | ok: "artifacts" 2025-11-19 05:48:09.496461 | controller | ok: "docs" 2025-11-19 05:48:09.512307 | 2025-11-19 05:48:09.512413 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2025-11-19 05:48:09.751942 | controller | changed: "logs" 2025-11-19 05:48:09.948416 | controller | changed: "artifacts" 2025-11-19 05:48:10.141847 | controller | changed: "docs" 2025-11-19 05:48:10.214259 | 2025-11-19 05:48:10.214371 | PLAY RECAP 2025-11-19 05:48:10.214412 | controller | ok: 30 changed: 16 unreachable: 0 failed: 0 skipped: 18 rescued: 0 ignored: 0 2025-11-19 05:48:10.214437 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-11-19 05:48:10.214455 | 2025-11-19 05:48:10.310312 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/ansible/zuul-config/playbooks/base/pre.yaml@master] 2025-11-19 05:48:10.311746 | PRE-RUN START: [untrusted : github.com/ansible/ansible-zuul-jobs/playbooks/ansible-galaxy-importer/pre.yaml@master] 2025-11-19 05:48:10.888829 | 2025-11-19 05:48:10.888952 | PLAY [all] 2025-11-19 05:48:10.909144 | 2025-11-19 05:48:10.909272 | TASK [Setup ensure-tox role] 2025-11-19 05:48:10.928528 | controller | ok 2025-11-19 05:48:10.950623 | 2025-11-19 05:48:10.950693 | TASK [Install pip] 2025-11-19 05:48:10.969874 | controller | ok 2025-11-19 05:48:10.990305 | 2025-11-19 05:48:10.990367 | TASK [ensure-pip : Check if pip is installed] 2025-11-19 05:48:11.356351 | controller | /usr/bin/pip3 2025-11-19 05:48:11.369957 | controller | /usr/bin/python3: No module named wheel 2025-11-19 05:48:11.520898 | controller | ok: Runtime: 0:00:00.023770 2025-11-19 05:48:11.533292 | 2025-11-19 05:48:11.533438 | LOOP [ensure-pip : Install pip from packages] 2025-11-19 05:48:11.559612 | controller | ok: "/var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/untrusted/project_2/opendev.org/zuul/zuul-jobs/roles/ensure-pip/tasks/RedHat.yaml" 2025-11-19 05:48:11.577127 | controller | included: /var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/untrusted/project_2/opendev.org/zuul/zuul-jobs/roles/ensure-pip/tasks/RedHat.yaml 2025-11-19 05:48:11.596597 | 2025-11-19 05:48:11.596681 | TASK [ensure-pip : Install Python 3 pip] 2025-11-19 05:48:16.482123 | controller | changed 2025-11-19 05:48:16.494494 | 2025-11-19 05:48:16.494635 | TASK [ensure-pip : Check for EPEL repository] 2025-11-19 05:48:16.521810 | controller | skipping: Conditional result was False 2025-11-19 05:48:16.535591 | 2025-11-19 05:48:16.535738 | TASK [ensure-pip : Fail with instructions when EPEL is not installed] 2025-11-19 05:48:16.563572 | controller | skipping: Conditional result was False 2025-11-19 05:48:16.577447 | 2025-11-19 05:48:16.577594 | TASK [ensure-pip : Install Python 2 pip] 2025-11-19 05:48:16.604519 | controller | skipping: Conditional result was False 2025-11-19 05:48:16.617603 | 2025-11-19 05:48:16.617772 | TASK [ensure-pip : Ensure setuptools] 2025-11-19 05:48:16.645834 | controller | skipping: Conditional result was False 2025-11-19 05:48:16.661368 | 2025-11-19 05:48:16.661517 | TASK [ensure-pip : Check for ensurepip module] 2025-11-19 05:48:17.209666 | controller | skipping: Conditional result was False 2025-11-19 05:48:17.223830 | 2025-11-19 05:48:17.223993 | TASK [ensure-pip : Ensure python3-venv] 2025-11-19 05:48:17.250922 | controller | skipping: Conditional result was False 2025-11-19 05:48:17.264425 | 2025-11-19 05:48:17.264571 | TASK [ensure-pip : Install pip from source] 2025-11-19 05:48:17.291371 | controller | skipping: Conditional result was False 2025-11-19 05:48:17.304212 | 2025-11-19 05:48:17.304357 | TASK [ensure-pip : Probe for venv python full path] 2025-11-19 05:48:17.621333 | controller | /usr/bin/python3 2025-11-19 05:48:17.854732 | controller | ok: Runtime: 0:00:00.003153 2025-11-19 05:48:17.867137 | 2025-11-19 05:48:17.867272 | TASK [ensure-pip : Set host default] 2025-11-19 05:48:17.946934 | controller | ok 2025-11-19 05:48:17.958438 | 2025-11-19 05:48:17.958571 | TASK [ensure-pip : Set ensure_pip_virtualenv_command] 2025-11-19 05:48:18.030237 | controller | ok 2025-11-19 05:48:18.053480 | 2025-11-19 05:48:18.053613 | TASK [ensure-tox : Check if tox is installed] 2025-11-19 05:48:18.341716 | controller | /usr/bin/tox 2025-11-19 05:48:18.601440 | controller | ok: Runtime: 0:00:00.003425 2025-11-19 05:48:18.614588 | 2025-11-19 05:48:18.614728 | TASK [ensure-tox : Export preinstalled tox_exectuable] 2025-11-19 05:48:18.666105 | controller | ok 2025-11-19 05:48:18.677326 | 2025-11-19 05:48:18.677454 | TASK [ensure-tox : Create local venv] 2025-11-19 05:48:19.229222 | controller | skipping: Conditional result was False 2025-11-19 05:48:19.242757 | 2025-11-19 05:48:19.242897 | TASK [ensure-tox : Install tox to local venv] 2025-11-19 05:48:19.801582 | controller | skipping: Conditional result was False 2025-11-19 05:48:19.815562 | 2025-11-19 05:48:19.815711 | TASK [ensure-tox : Export installed tox_executable path] 2025-11-19 05:48:19.843423 | controller | skipping: Conditional result was False 2025-11-19 05:48:19.856215 | 2025-11-19 05:48:19.856352 | TASK [ensure-tox : Output tox version] 2025-11-19 05:48:20.250778 | controller | 3.28.0 imported from /usr/lib/python3.11/site-packages/tox/__init__.py 2025-11-19 05:48:20.411655 | controller | ok: Runtime: 0:00:00.149487 2025-11-19 05:48:20.424788 | 2025-11-19 05:48:20.424934 | TASK [ensure-tox : Make global symlink] 2025-11-19 05:48:20.452946 | controller | skipping: Conditional result was False 2025-11-19 05:48:20.476958 | 2025-11-19 05:48:20.477158 | TASK [Setup tox role] 2025-11-19 05:48:20.510207 | controller | ok 2025-11-19 05:48:20.551044 | 2025-11-19 05:48:20.551192 | TASK [tox : Check to see if the constraints file exists] 2025-11-19 05:48:20.576214 | controller | skipping: Conditional result was False 2025-11-19 05:48:20.582174 | 2025-11-19 05:48:20.582238 | TASK [tox : Fail if constraints file is missing] 2025-11-19 05:48:20.616283 | controller | skipping: Conditional result was False 2025-11-19 05:48:20.628712 | 2025-11-19 05:48:20.628856 | TASK [tox : Record file location] 2025-11-19 05:48:20.655764 | controller | skipping: Conditional result was False 2025-11-19 05:48:20.668615 | 2025-11-19 05:48:20.668746 | TASK [tox : Install tox siblings] 2025-11-19 05:48:20.686577 | controller | skipping: Conditional result was False 2025-11-19 05:48:20.702631 | 2025-11-19 05:48:20.702770 | TASK [tox : Emit tox command] 2025-11-19 05:48:20.751119 | /usr/bin/tox -evenv -vv --notest 2025-11-19 05:48:20.762763 | 2025-11-19 05:48:20.762902 | TASK [tox : Run tox] 2025-11-19 05:48:21.144271 | controller | using tox.ini: /home/zuul/src/github.com/ansible-network/releases/tox.ini (pid 2322) 2025-11-19 05:48:21.151402 | controller | using tox-3.28.0 from /usr/lib/python3.11/site-packages/tox/__init__.py (pid 2322) 2025-11-19 05:48:21.172529 | controller | skipping sdist step 2025-11-19 05:48:21.172547 | controller | venv uses /usr/bin/python3 2025-11-19 05:48:21.172563 | controller | venv start: getenv /home/zuul/src/github.com/ansible-network/releases/.tox/venv 2025-11-19 05:48:21.172730 | controller | venv cannot reuse: no previous config /home/zuul/src/github.com/ansible-network/releases/.tox/venv/.tox-config1 2025-11-19 05:48:21.172743 | controller | venv create: /home/zuul/src/github.com/ansible-network/releases/.tox/venv 2025-11-19 05:48:21.172751 | 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-11-19 05:48:21.172760 | controller | [2330] /home/zuul/src/github.com/ansible-network/releases/.tox$ /usr/bin/python3 -m virtualenv --no-download --python /usr/bin/python3 venv 2025-11-19 05:48:21.743437 | controller | created virtual environment CPython3.11.0.final.0-64 in 492ms 2025-11-19 05:48:21.768216 | controller | creator CPython3Posix(dest=/home/zuul/src/github.com/ansible-network/releases/.tox/venv, clear=False, no_vcs_ignore=False, global=False) 2025-11-19 05:48:21.768245 | 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-11-19 05:48:21.768253 | controller | added seed packages: pip==22.2.2, setuptools==62.6.0, wheel==0.37.1 2025-11-19 05:48:21.768257 | controller | activators BashActivator,CShellActivator,FishActivator,NushellActivator,PowerShellActivator,PythonActivator 2025-11-19 05:48:21.768267 | 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-11-19 05:48:21.768597 | 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-11-19 05:48:21.768616 | controller | [2338] /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-11-19 05:52:59.438358 | [Zuul] Log Stream did not terminate 2025-11-19 05:52:59.438545 | controller | ERROR 2025-11-19 05:52:59.438623 | controller | { 2025-11-19 05:52:59.438649 | controller | "msg": "Data could not be sent to remote host \"162.253.55.213\". Make sure this host can be reached over ssh: ssh: connect to host 162.253.55.213 port 22: No route to host\r\n", 2025-11-19 05:52:59.438669 | controller | "unreachable": true 2025-11-19 05:52:59.438687 | controller | } unreachable 2025-11-19 05:52:59.439982 | 2025-11-19 05:52:59.440051 | PLAY RECAP 2025-11-19 05:52:59.440101 | controller | ok: 10 changed: 5 unreachable: 1 failed: 0 skipped: 15 rescued: 0 ignored: 0 2025-11-19 05:52:59.440124 | 2025-11-19 05:52:59.527355 | PRE-RUN END RESULT_UNREACHABLE: [untrusted : github.com/ansible/ansible-zuul-jobs/playbooks/ansible-galaxy-importer/pre.yaml@master] 2025-11-19 05:52:59.528907 | POST-RUN START: [trusted : github.com/ansible/zuul-config/playbooks/base/post.yaml@master] 2025-11-19 05:53:00.082778 | 2025-11-19 05:53:00.082884 | PLAY [all:!appliance*] 2025-11-19 05:53:00.103553 | 2025-11-19 05:53:00.103626 | TASK [unregister the node] 2025-11-19 05:53:02.600355 | [controller] Waiting on logger 2025-11-19 05:53:22.631223 | controller | skipping: Conditional result was False 2025-11-19 05:53:22.643178 | 2025-11-19 05:53:22.643345 | TASK [include_role : fetch-output] 2025-11-19 05:53:22.691499 | controller | ok 2025-11-19 05:53:22.729562 | 2025-11-19 05:53:22.729704 | TASK [fetch-output : Set log path for multiple nodes] 2025-11-19 05:53:22.796431 | controller | skipping: Conditional result was False 2025-11-19 05:53:22.809878 | 2025-11-19 05:53:22.810072 | TASK [fetch-output : Set log path for single node] 2025-11-19 05:53:22.859099 | controller | ok 2025-11-19 05:53:22.871505 | 2025-11-19 05:53:22.871679 | LOOP [fetch-output : Ensure local output dirs] 2025-11-19 05:53:23.303333 | controller -> localhost | ok: "/var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/logs" 2025-11-19 05:53:23.519701 | controller -> localhost | changed: "/var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/artifacts" 2025-11-19 05:53:23.711414 | controller -> localhost | changed: "/var/lib/zuul/builds/174321edcac646e0b44d4ed942c5c9fb/work/docs" 2025-11-19 05:53:23.728717 | 2025-11-19 05:53:23.728863 | LOOP [fetch-output : Collect logs, artifacts and docs] 2025-11-19 05:53:24.383432 | controller | changed: .d..t...... ./ 2025-11-19 05:53:24.383663 | controller | changed: All items complete 2025-11-19 05:53:24.383700 | 2025-11-19 05:53:24.922220 | controller | changed: .d..t...... ./ 2025-11-19 05:53:25.497488 | controller | changed: .d..t...... ./ 2025-11-19 05:53:25.526596 | 2025-11-19 05:53:25.526756 | TASK [include_role : fetch-output-openshift] 2025-11-19 05:53:25.545257 | controller | skipping: Conditional result was False 2025-11-19 05:53:25.558593 | 2025-11-19 05:53:25.558730 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2025-11-19 05:53:26.014309 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.010586 2025-11-19 05:53:26.297654 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.011153 2025-11-19 05:53:26.325296 | 2025-11-19 05:53:26.325367 | PLAY [localhost] 2025-11-19 05:53:26.337505 | 2025-11-19 05:53:26.337564 | TASK [Run Zuul manifest role] 2025-11-19 05:53:26.356233 | localhost | ok 2025-11-19 05:53:26.369447 | 2025-11-19 05:53:26.369509 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2025-11-19 05:53:26.788893 | localhost | changed 2025-11-19 05:53:26.798263 | 2025-11-19 05:53:26.798389 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2025-11-19 05:53:26.835994 | localhost | ok 2025-11-19 05:53:26.854799 | 2025-11-19 05:53:26.854927 | TASK [Set zuul-log-path fact] 2025-11-19 05:53:26.876919 | localhost | ok 2025-11-19 05:53:26.895599 | 2025-11-19 05:53:26.895697 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-11-19 05:53:26.936163 | localhost | ok 2025-11-19 05:53:26.947287 | 2025-11-19 05:53:26.947366 | LOOP [Run upload-logs-swift role] 2025-11-19 05:53:26.984053 | localhost | Output suppressed because no_log was given 2025-11-19 05:53:27.033645 | 2025-11-19 05:53:27.033753 | TASK [Set zuul-log-path fact] 2025-11-19 05:53:27.109241 | localhost | skipping: Conditional result was False 2025-11-19 05:53:27.145120 | 2025-11-19 05:53:27.145258 | TASK [upload-logs-swift : Ensure logs are readable before uploading] 2025-11-19 05:53:27.465582 | localhost -> localhost | ok: Runtime: 0:00:00.004651 2025-11-19 05:53:27.476615 | 2025-11-19 05:53:27.476742 | TASK [upload-logs-swift : Upload logs to swift]