2026-03-10 00:11:52.569867 | Job console starting... 2026-03-10 00:11:52.581745 | Updating repositories 2026-03-10 00:11:52.726128 | Preparing job workspace 2026-03-10 00:11:56.998337 | Running Ansible setup... 2026-03-10 00:12:01.949191 | PRE-RUN START: [trusted : github.com/ansible/zuul-config/playbooks/base/pre.yaml@master] 2026-03-10 00:12:02.758960 | 2026-03-10 00:12:02.759123 | PLAY [localhost] 2026-03-10 00:12:02.768942 | 2026-03-10 00:12:02.769078 | TASK [Gathering Facts] 2026-03-10 00:12:03.765544 | localhost | ok 2026-03-10 00:12:03.800746 | 2026-03-10 00:12:03.800990 | TASK [Setup log path fact] 2026-03-10 00:12:03.822463 | localhost | ok 2026-03-10 00:12:03.840571 | 2026-03-10 00:12:03.840705 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-03-10 00:12:03.871738 | localhost | ok 2026-03-10 00:12:03.883268 | 2026-03-10 00:12:03.883374 | TASK [emit-job-header : Print job information] 2026-03-10 00:12:03.927062 | # Job Information 2026-03-10 00:12:03.927307 | Ansible Version: 2.15.12 2026-03-10 00:12:03.927393 | Job: ansible-test-sanity-docker-milestone 2026-03-10 00:12:03.927444 | Pipeline: periodic 2026-03-10 00:12:03.927484 | Executor: ze01.softwarefactory-project.io 2026-03-10 00:12:03.927575 | Triggered by: https://github.com/ansible-collections/ansible.network 2026-03-10 00:12:03.927644 | Log URL (when completed): https://ansible.softwarefactory-project.io/logs/eca/ansible/eca09c0c94d44ce0a63dc90f7bd50946/ 2026-03-10 00:12:03.927687 | Event ID: e6ee9e03205a430c87790b3a203d0d50 2026-03-10 00:12:03.936409 | 2026-03-10 00:12:03.936537 | LOOP [emit-job-header : Print node information] 2026-03-10 00:12:04.065092 | localhost | ok: 2026-03-10 00:12:04.065378 | localhost | # Node Information 2026-03-10 00:12:04.065428 | localhost | Inventory Hostname: controller 2026-03-10 00:12:04.065462 | localhost | Hostname: np0005642991 2026-03-10 00:12:04.065492 | localhost | Username: zuul 2026-03-10 00:12:04.065529 | localhost | Distro: Fedora 37 2026-03-10 00:12:04.065558 | localhost | Provider: ansible-vexxhost-ca-ymq-1 2026-03-10 00:12:04.065589 | localhost | Region: ca-ymq-1 2026-03-10 00:12:04.065622 | localhost | Label: ansible-fedora-37-1vcpu 2026-03-10 00:12:04.065649 | localhost | Product Name: OpenStack Nova 2026-03-10 00:12:04.065680 | localhost | Interface IP: 162.253.55.140 2026-03-10 00:12:04.079155 | 2026-03-10 00:12:04.079333 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-03-10 00:12:04.503854 | localhost -> localhost | changed 2026-03-10 00:12:04.511035 | 2026-03-10 00:12:04.511151 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-03-10 00:12:05.475610 | localhost -> localhost | changed 2026-03-10 00:12:05.502120 | 2026-03-10 00:12:05.502221 | PLAY [all:!appliance*] 2026-03-10 00:12:05.525091 | 2026-03-10 00:12:05.525229 | TASK [include_role : start-zuul-console] 2026-03-10 00:12:05.547181 | controller | ok 2026-03-10 00:12:05.566511 | 2026-03-10 00:12:05.566653 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-03-10 00:12:05.942620 | controller | ok 2026-03-10 00:12:05.968621 | 2026-03-10 00:12:05.968829 | TASK [use-our-mirror : Retrieve the IP address] 2026-03-10 00:12:06.992602 | controller | ok: Status code was 404 and not [200]: HTTP Error 404: Not Found 2026-03-10 00:12:07.011270 | 2026-03-10 00:12:07.011459 | TASK [use-our-mirror : Ensure the registry service is running on the mirror] 2026-03-10 00:12:07.561368 | controller | skipping: Conditional result was False 2026-03-10 00:12:07.571921 | 2026-03-10 00:12:07.572144 | TASK [use-our-mirror : Write the IP in /etc/hosts] 2026-03-10 00:12:07.600229 | controller | skipping: Conditional result was False 2026-03-10 00:12:07.611129 | 2026-03-10 00:12:07.611318 | TASK [use-our-mirror : Create the podman configuration directory] 2026-03-10 00:12:07.648296 | controller | skipping: Conditional result was False 2026-03-10 00:12:07.655984 | 2026-03-10 00:12:07.656162 | TASK [use-our-mirror : Copy the podman configuration] 2026-03-10 00:12:07.691481 | controller | skipping: Conditional result was False 2026-03-10 00:12:07.700527 | 2026-03-10 00:12:07.700706 | TASK [use-our-mirror : Copy the Yum configuration (main)] 2026-03-10 00:12:07.737113 | controller | skipping: Conditional result was False 2026-03-10 00:12:07.745957 | 2026-03-10 00:12:07.746133 | TASK [use-our-mirror : Copy the Yum configuration (update)] 2026-03-10 00:12:07.771998 | controller | skipping: Conditional result was False 2026-03-10 00:12:07.788984 | 2026-03-10 00:12:07.789122 | TASK [Disable Fedora Modular] 2026-03-10 00:12:08.045177 | controller | changed 2026-03-10 00:12:08.053096 | 2026-03-10 00:12:08.053178 | TASK [Enable EPEL] 2026-03-10 00:12:08.077585 | controller | skipping: Conditional result was False 2026-03-10 00:12:08.083796 | 2026-03-10 00:12:08.083877 | TASK [Register the RHEL node] 2026-03-10 00:12:08.646646 | 2026-03-10 00:12:08.646811 | TASK [Show the subscription-manager status] 2026-03-10 00:12:09.205321 | controller | skipping: Conditional result was False 2026-03-10 00:12:09.211753 | 2026-03-10 00:12:09.211832 | TASK [Enable EPEL on RHEL] 2026-03-10 00:12:09.747998 | controller | skipping: Conditional result was False 2026-03-10 00:12:09.754215 | 2026-03-10 00:12:09.754294 | TASK [Install git and tox] 2026-03-10 00:13:26.705064 | controller | changed 2026-03-10 00:13:26.711813 | 2026-03-10 00:13:26.711924 | TASK [include_role : prepare-workspace] 2026-03-10 00:13:26.743272 | controller | ok 2026-03-10 00:13:26.767798 | 2026-03-10 00:13:26.767931 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-03-10 00:13:27.014542 | controller | ok 2026-03-10 00:13:27.022143 | 2026-03-10 00:13:27.022249 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-03-10 00:13:39.483252 | controller | Output suppressed because no_log was given 2026-03-10 00:13:39.493045 | 2026-03-10 00:13:39.493128 | TASK [include_role : prepare-workspace-openshift] 2026-03-10 00:13:39.517183 | controller | skipping: Conditional result was False 2026-03-10 00:13:39.551861 | 2026-03-10 00:13:39.551971 | PLAY [all:!appliance] 2026-03-10 00:13:39.571631 | 2026-03-10 00:13:39.571714 | TASK [Run add-build-sshkey role (RSA)] 2026-03-10 00:13:39.591740 | controller | ok 2026-03-10 00:13:39.607988 | 2026-03-10 00:13:39.608123 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-03-10 00:13:39.837414 | controller -> localhost | ok 2026-03-10 00:13:39.843964 | 2026-03-10 00:13:39.844080 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-03-10 00:13:39.875767 | controller | ok 2026-03-10 00:13:39.905159 | controller | included: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-03-10 00:13:39.914062 | 2026-03-10 00:13:39.914184 | TASK [add-build-sshkey : Create Temp SSH key] 2026-03-10 00:13:40.382229 | controller -> localhost | Generating public/private rsa key pair. 2026-03-10 00:13:40.382492 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/eca09c0c94d44ce0a63dc90f7bd50946_id_rsa. 2026-03-10 00:13:40.382534 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/eca09c0c94d44ce0a63dc90f7bd50946_id_rsa.pub. 2026-03-10 00:13:40.382565 | controller -> localhost | The key fingerprint is: 2026-03-10 00:13:40.382593 | controller -> localhost | SHA256:RpZgLgrSmDVc1HKPrN4w+YviGyXLbfA9tx60pT0UUm8 zuul-build-sshkey 2026-03-10 00:13:40.382623 | controller -> localhost | The key's randomart image is: 2026-03-10 00:13:40.382650 | controller -> localhost | +---[RSA 2048]----+ 2026-03-10 00:13:40.382676 | controller -> localhost | | .ooo.o . | 2026-03-10 00:13:40.382703 | controller -> localhost | | =...oo. o . | 2026-03-10 00:13:40.382729 | controller -> localhost | |= . .+.o= . E | 2026-03-10 00:13:40.382755 | controller -> localhost | |.. . .oo.. o | 2026-03-10 00:13:40.382780 | controller -> localhost | | + .o S o | 2026-03-10 00:13:40.382816 | controller -> localhost | | . B=. o * | 2026-03-10 00:13:40.382849 | controller -> localhost | | +.+=o = o | 2026-03-10 00:13:40.382877 | controller -> localhost | | .o..oo o . | 2026-03-10 00:13:40.382904 | controller -> localhost | | .oo. .oo | 2026-03-10 00:13:40.382935 | controller -> localhost | +----[SHA256]-----+ 2026-03-10 00:13:40.383004 | controller -> localhost | ok: Runtime: 0:00:00.076919 2026-03-10 00:13:40.393748 | 2026-03-10 00:13:40.393889 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-03-10 00:13:40.426824 | controller | ok 2026-03-10 00:13:40.440941 | controller | included: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-03-10 00:13:40.453982 | 2026-03-10 00:13:40.454104 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-03-10 00:13:40.478996 | controller | skipping: Conditional result was False 2026-03-10 00:13:40.488097 | 2026-03-10 00:13:40.488191 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-03-10 00:13:40.917566 | controller | changed 2026-03-10 00:13:40.923188 | 2026-03-10 00:13:40.923253 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-03-10 00:13:41.138249 | controller | ok 2026-03-10 00:13:41.144332 | 2026-03-10 00:13:41.144418 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-03-10 00:13:41.787872 | controller | changed 2026-03-10 00:13:41.804397 | 2026-03-10 00:13:41.804646 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-03-10 00:13:42.427338 | controller | changed 2026-03-10 00:13:42.437244 | 2026-03-10 00:13:42.437409 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-03-10 00:13:42.464509 | controller | skipping: Conditional result was False 2026-03-10 00:13:42.471775 | 2026-03-10 00:13:42.471884 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-03-10 00:13:42.874392 | controller -> localhost | changed 2026-03-10 00:13:42.887565 | 2026-03-10 00:13:42.887667 | TASK [add-build-sshkey : Add back temp key] 2026-03-10 00:13:43.187646 | controller -> localhost | Identity added: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/eca09c0c94d44ce0a63dc90f7bd50946_id_rsa (zuul-build-sshkey) 2026-03-10 00:13:43.187846 | controller -> localhost | ok: Runtime: 0:00:00.009445 2026-03-10 00:13:43.194537 | 2026-03-10 00:13:43.194598 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-03-10 00:13:43.534168 | controller | ok 2026-03-10 00:13:43.542389 | 2026-03-10 00:13:43.542495 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-03-10 00:13:43.579051 | controller | skipping: Conditional result was False 2026-03-10 00:13:43.591752 | 2026-03-10 00:13:43.591857 | TASK [Run add-build-sshkey role (ECDSA)] 2026-03-10 00:13:43.627248 | controller | ok 2026-03-10 00:13:43.653476 | 2026-03-10 00:13:43.653634 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-03-10 00:13:43.908929 | controller -> localhost | ok 2026-03-10 00:13:43.923178 | 2026-03-10 00:13:43.923305 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-03-10 00:13:43.946887 | controller | ok 2026-03-10 00:13:43.963119 | controller | included: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-03-10 00:13:43.970995 | 2026-03-10 00:13:43.971101 | TASK [add-build-sshkey : Create Temp SSH key] 2026-03-10 00:13:44.293402 | controller -> localhost | Generating public/private ecdsa key pair. 2026-03-10 00:13:44.293733 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/eca09c0c94d44ce0a63dc90f7bd50946_id_ecdsa. 2026-03-10 00:13:44.293799 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/eca09c0c94d44ce0a63dc90f7bd50946_id_ecdsa.pub. 2026-03-10 00:13:44.293864 | controller -> localhost | The key fingerprint is: 2026-03-10 00:13:44.293911 | controller -> localhost | SHA256:w+FwOLkleKh0qUsHYXdw7+sVETdxt5PjP8/g8db9m+s zuul-build-sshkey 2026-03-10 00:13:44.293954 | controller -> localhost | The key's randomart image is: 2026-03-10 00:13:44.293998 | controller -> localhost | +---[ECDSA 521]---+ 2026-03-10 00:13:44.294079 | controller -> localhost | | o o.o . +.. .| 2026-03-10 00:13:44.294125 | controller -> localhost | | . o * + o o .o| 2026-03-10 00:13:44.294167 | controller -> localhost | | o = B = . = | 2026-03-10 00:13:44.294209 | controller -> localhost | | . = . @ . . . o| 2026-03-10 00:13:44.294250 | controller -> localhost | | + . . S . . | 2026-03-10 00:13:44.294291 | controller -> localhost | | . o o . .| 2026-03-10 00:13:44.294331 | controller -> localhost | | . . . o.+| 2026-03-10 00:13:44.294371 | controller -> localhost | | . . . =B| 2026-03-10 00:13:44.294411 | controller -> localhost | | . oEO| 2026-03-10 00:13:44.294451 | controller -> localhost | +----[SHA256]-----+ 2026-03-10 00:13:44.294551 | controller -> localhost | ok: Runtime: 0:00:00.010225 2026-03-10 00:13:44.312562 | 2026-03-10 00:13:44.312713 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-03-10 00:13:44.354881 | controller | ok 2026-03-10 00:13:44.373476 | controller | included: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-03-10 00:13:44.390654 | 2026-03-10 00:13:44.390756 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-03-10 00:13:44.416243 | controller | skipping: Conditional result was False 2026-03-10 00:13:44.427005 | 2026-03-10 00:13:44.427143 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-03-10 00:13:44.718130 | controller | changed 2026-03-10 00:13:44.727424 | 2026-03-10 00:13:44.727565 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-03-10 00:13:44.945006 | controller | ok 2026-03-10 00:13:44.953611 | 2026-03-10 00:13:44.953739 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-03-10 00:13:45.584484 | controller | changed 2026-03-10 00:13:45.591528 | 2026-03-10 00:13:45.591604 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-03-10 00:13:46.192146 | controller | changed 2026-03-10 00:13:46.210919 | 2026-03-10 00:13:46.211085 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-03-10 00:13:46.246426 | controller | skipping: Conditional result was False 2026-03-10 00:13:46.255535 | 2026-03-10 00:13:46.255634 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-03-10 00:13:46.546157 | controller -> localhost | changed 2026-03-10 00:13:46.611830 | 2026-03-10 00:13:46.612119 | TASK [add-build-sshkey : Add back temp key] 2026-03-10 00:13:46.935976 | controller -> localhost | Identity added: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/eca09c0c94d44ce0a63dc90f7bd50946_id_ecdsa (zuul-build-sshkey) 2026-03-10 00:13:46.936405 | controller -> localhost | ok: Runtime: 0:00:00.015222 2026-03-10 00:13:46.949479 | 2026-03-10 00:13:46.949623 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-03-10 00:13:47.158514 | controller | ok 2026-03-10 00:13:47.170790 | 2026-03-10 00:13:47.170959 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-03-10 00:13:47.207506 | controller | skipping: Conditional result was False 2026-03-10 00:13:47.226170 | 2026-03-10 00:13:47.226265 | TASK [include_role : remove-zuul-sshkey] 2026-03-10 00:13:47.251501 | controller | skipping: Conditional result was False 2026-03-10 00:13:47.261364 | 2026-03-10 00:13:47.261489 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-03-10 00:13:47.491409 | controller | ok: "logs" 2026-03-10 00:13:47.492305 | controller | ok: All items complete 2026-03-10 00:13:47.492399 | 2026-03-10 00:13:47.670965 | controller | ok: "artifacts" 2026-03-10 00:13:47.868875 | controller | ok: "docs" 2026-03-10 00:13:47.891702 | 2026-03-10 00:13:47.891879 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-03-10 00:13:48.130240 | controller | changed: "logs" 2026-03-10 00:13:48.321765 | controller | changed: "artifacts" 2026-03-10 00:13:48.523847 | controller | changed: "docs" 2026-03-10 00:13:48.573878 | 2026-03-10 00:13:48.574063 | PLAY RECAP 2026-03-10 00:13:48.574131 | controller | ok: 30 changed: 16 unreachable: 0 failed: 0 skipped: 18 rescued: 0 ignored: 0 2026-03-10 00:13:48.574168 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-03-10 00:13:48.574192 | 2026-03-10 00:13:48.708533 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/ansible/zuul-config/playbooks/base/pre.yaml@master] 2026-03-10 00:13:48.709725 | PRE-RUN START: [untrusted : opendev.org/zuul/zuul-jobs/playbooks/unittests/pre.yaml@master] 2026-03-10 00:13:49.359718 | 2026-03-10 00:13:49.359929 | PLAY [all] 2026-03-10 00:13:49.390334 | 2026-03-10 00:13:49.390569 | TASK [Install binary dependencies] 2026-03-10 00:13:49.465591 | controller | ok 2026-03-10 00:13:49.490929 | 2026-03-10 00:13:49.491199 | TASK [bindep : Include find tasks] 2026-03-10 00:13:49.544787 | controller | ok 2026-03-10 00:13:49.554239 | controller | included: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/untrusted/project_0/opendev.org/zuul/zuul-jobs/roles/bindep/tasks/find.yaml 2026-03-10 00:13:49.564120 | 2026-03-10 00:13:49.564345 | TASK [bindep : Look for bindep.txt] 2026-03-10 00:13:49.976994 | controller | ok 2026-03-10 00:13:49.990598 | 2026-03-10 00:13:49.990711 | TASK [bindep : Define bindep_file fact] 2026-03-10 00:13:50.008885 | controller | skipping: Conditional result was False 2026-03-10 00:13:50.018408 | 2026-03-10 00:13:50.018516 | TASK [bindep : Look for other-requirements.txt] 2026-03-10 00:13:50.229163 | controller | ok 2026-03-10 00:13:50.237649 | 2026-03-10 00:13:50.237751 | TASK [bindep : Define bindep_file fact] 2026-03-10 00:13:50.274936 | controller | skipping: Conditional result was False 2026-03-10 00:13:50.286474 | 2026-03-10 00:13:50.286604 | TASK [bindep : Look for bindep fallback file] 2026-03-10 00:13:50.325105 | controller | skipping: Conditional result was False 2026-03-10 00:13:50.334213 | 2026-03-10 00:13:50.334323 | TASK [bindep : Define bindep_file fact] 2026-03-10 00:13:50.360912 | controller | skipping: Conditional result was False 2026-03-10 00:13:50.370773 | 2026-03-10 00:13:50.370873 | TASK [bindep : Include bindep tasks] 2026-03-10 00:13:50.397376 | controller | skipping: Conditional result was False 2026-03-10 00:13:50.406828 | 2026-03-10 00:13:50.406932 | TASK [bindep : Include install tasks] 2026-03-10 00:13:50.432997 | controller | skipping: Conditional result was False 2026-03-10 00:13:50.445904 | 2026-03-10 00:13:50.446210 | LOOP [bindep : Include package tasks] 2026-03-10 00:13:50.532147 | 2026-03-10 00:13:50.532389 | TASK [Run test-setup role] 2026-03-10 00:13:50.567674 | controller | ok 2026-03-10 00:13:50.587700 | 2026-03-10 00:13:50.587910 | TASK [test-setup : Check if project's tools/test-setup.sh exists] 2026-03-10 00:13:50.802938 | controller | ok 2026-03-10 00:13:50.817543 | 2026-03-10 00:13:50.817729 | TASK [test-setup : Run tools/test-setup.sh] 2026-03-10 00:13:51.369492 | controller | skipping: Conditional result was False 2026-03-10 00:13:51.425217 | 2026-03-10 00:13:51.425381 | PLAY RECAP 2026-03-10 00:13:51.425460 | controller | ok: 4 changed: 0 unreachable: 0 failed: 0 skipped: 8 rescued: 0 ignored: 0 2026-03-10 00:13:51.425497 | 2026-03-10 00:13:51.619375 | PRE-RUN END RESULT_NORMAL: [untrusted : opendev.org/zuul/zuul-jobs/playbooks/unittests/pre.yaml@master] 2026-03-10 00:13:51.620544 | PRE-RUN START: [untrusted : github.com/ansible/ansible-zuul-jobs/playbooks/ansible-test-base/pre.yaml@master] 2026-03-10 00:13:52.385176 | 2026-03-10 00:13:52.385389 | PLAY [controller] 2026-03-10 00:13:52.408499 | 2026-03-10 00:13:52.408636 | TASK [Create the /root directory] 2026-03-10 00:13:52.833262 | controller | ok 2026-03-10 00:13:52.844328 | 2026-03-10 00:13:52.844507 | TASK [Install glibc-langpack-en] 2026-03-10 00:16:05.193750 | controller | ERROR 2026-03-10 00:16:05.194062 | controller | { 2026-03-10 00:16:05.194119 | controller | "msg": "Timeout (32s) waiting for privilege escalation prompt: " 2026-03-10 00:16:05.194153 | controller | } failure 2026-03-10 00:16:05.199951 | 2026-03-10 00:16:05.200097 | PLAY RECAP 2026-03-10 00:16:05.200193 | controller | ok: 1 changed: 0 unreachable: 0 failed: 1 skipped: 0 rescued: 0 ignored: 0 2026-03-10 00:16:05.200231 | 2026-03-10 00:16:05.322715 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/ansible/ansible-zuul-jobs/playbooks/ansible-test-base/pre.yaml@master] 2026-03-10 00:16:05.323959 | POST-RUN START: [untrusted : opendev.org/zuul/zuul-jobs/playbooks/unittests/post.yaml@master] 2026-03-10 00:16:05.943295 | 2026-03-10 00:16:05.943423 | PLAY [all] 2026-03-10 00:16:05.981800 | 2026-03-10 00:16:05.981961 | TASK [fetch-subunit-output : Find stestr or testr executable] 2026-03-10 00:19:29.413799 | controller | changed: non-zero return code 2026-03-10 00:19:29.429137 | 2026-03-10 00:19:29.429355 | TASK [fetch-subunit-output : Get the list of directories with subunit files] 2026-03-10 00:19:29.446961 | controller | skipping: Conditional result was False 2026-03-10 00:19:29.456208 | 2026-03-10 00:19:29.456349 | LOOP [fetch-subunit-output : Find any inflight partial subunit files] 2026-03-10 00:19:29.491753 | 2026-03-10 00:19:29.491962 | LOOP [fetch-subunit-output : Copy any inflight subunit files] 2026-03-10 00:19:29.527949 | 2026-03-10 00:19:29.528193 | TASK [fetch-subunit-output : Create a temporary file to store the subunit stream] 2026-03-10 00:19:29.553285 | controller | skipping: Conditional result was False 2026-03-10 00:19:29.563365 | 2026-03-10 00:19:29.563470 | LOOP [fetch-subunit-output : Generate subunit file] 2026-03-10 00:19:29.597887 | 2026-03-10 00:19:29.598109 | TASK [fetch-subunit-output : Copy the combined subunit file to the zuul work directory] 2026-03-10 00:19:29.623560 | controller | skipping: Conditional result was False 2026-03-10 00:19:29.634416 | 2026-03-10 00:19:29.634605 | TASK [fetch-subunit-output : Remove the temporary file] 2026-03-10 00:19:29.651175 | controller | skipping: Conditional result was False 2026-03-10 00:19:29.662884 | 2026-03-10 00:19:29.663096 | TASK [fetch-subunit-output : Process and fetch subunit results] 2026-03-10 00:19:29.679186 | controller | skipping: Conditional result was False 2026-03-10 00:19:29.731082 | 2026-03-10 00:19:29.731204 | PLAY RECAP 2026-03-10 00:19:29.731261 | controller | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 8 rescued: 0 ignored: 0 2026-03-10 00:19:29.731286 | 2026-03-10 00:19:29.864105 | POST-RUN END RESULT_NORMAL: [untrusted : opendev.org/zuul/zuul-jobs/playbooks/unittests/post.yaml@master] 2026-03-10 00:19:29.865890 | POST-RUN START: [trusted : github.com/ansible/zuul-config/playbooks/base/post.yaml@master] 2026-03-10 00:19:30.522741 | 2026-03-10 00:19:30.522883 | PLAY [all:!appliance*] 2026-03-10 00:19:30.550369 | 2026-03-10 00:19:30.550532 | TASK [unregister the node] 2026-03-10 00:19:31.085789 | controller | skipping: Conditional result was False 2026-03-10 00:19:31.100641 | 2026-03-10 00:19:31.100853 | TASK [include_role : fetch-output] 2026-03-10 00:19:31.162686 | controller | ok 2026-03-10 00:19:31.200305 | 2026-03-10 00:19:31.200530 | TASK [fetch-output : Set log path for multiple nodes] 2026-03-10 00:19:31.248735 | controller | skipping: Conditional result was False 2026-03-10 00:19:31.264128 | 2026-03-10 00:19:31.264344 | TASK [fetch-output : Set log path for single node] 2026-03-10 00:19:31.306098 | controller | ok 2026-03-10 00:19:31.320474 | 2026-03-10 00:19:31.320687 | LOOP [fetch-output : Ensure local output dirs] 2026-03-10 00:19:31.725009 | controller -> localhost | ok: "/var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/logs" 2026-03-10 00:19:31.993893 | controller -> localhost | changed: "/var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/artifacts" 2026-03-10 00:19:32.246521 | controller -> localhost | changed: "/var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/work/docs" 2026-03-10 00:19:32.264407 | 2026-03-10 00:19:32.264596 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-03-10 00:19:33.052253 | controller | ok 2026-03-10 00:19:33.052510 | controller | changed: All items complete 2026-03-10 00:19:33.052549 | 2026-03-10 00:19:33.513479 | controller | changed: .d..t...... ./ 2026-03-10 00:19:34.078438 | controller | changed: .d..t...... ./ 2026-03-10 00:19:34.102141 | 2026-03-10 00:19:34.102288 | TASK [include_role : fetch-output-openshift] 2026-03-10 00:19:34.129574 | controller | skipping: Conditional result was False 2026-03-10 00:19:34.140042 | 2026-03-10 00:19:34.140167 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-03-10 00:19:34.183580 | controller | skipping: Conditional result was False 2026-03-10 00:19:34.198954 | controller | skipping: Conditional result was False 2026-03-10 00:19:34.237948 | 2026-03-10 00:19:34.238090 | PLAY [localhost] 2026-03-10 00:19:34.252080 | 2026-03-10 00:19:34.252193 | TASK [Run Zuul manifest role] 2026-03-10 00:19:34.273818 | localhost | ok 2026-03-10 00:19:34.289142 | 2026-03-10 00:19:34.289260 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-03-10 00:19:34.746277 | localhost | changed 2026-03-10 00:19:34.751680 | 2026-03-10 00:19:34.751758 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-03-10 00:19:34.792954 | localhost | ok 2026-03-10 00:19:34.801423 | 2026-03-10 00:19:34.801497 | TASK [Set zuul-log-path fact] 2026-03-10 00:19:34.820581 | localhost | ok 2026-03-10 00:19:34.835159 | 2026-03-10 00:19:34.835270 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-03-10 00:19:34.864526 | localhost | ok 2026-03-10 00:19:34.873356 | 2026-03-10 00:19:34.873443 | LOOP [Set zuul_log_targets (Swift with random Rackspace region)] 2026-03-10 00:19:34.897717 | localhost | ok: 2026-03-10 00:19:34.898045 | localhost | { 2026-03-10 00:19:34.898081 | localhost | "auth": { 2026-03-10 00:19:34.898102 | localhost | "password": "IonWCwcuOFib&&<}wp^:[2G/", 2026-03-10 00:19:34.898119 | localhost | "username": "9LF91O0RK7JU" 2026-03-10 00:19:34.898140 | localhost | }, 2026-03-10 00:19:34.898158 | localhost | "profile": "rackspace", 2026-03-10 00:19:34.898174 | localhost | "region_name": "ORD" 2026-03-10 00:19:34.898191 | localhost | } 2026-03-10 00:19:34.898222 | 2026-03-10 00:19:34.913181 | 2026-03-10 00:19:34.913291 | TASK [Run upload-logs-failover role (S3 then Swift)] 2026-03-10 00:19:34.931032 | localhost | Output suppressed because no_log was given 2026-03-10 00:19:34.944502 | 2026-03-10 00:19:34.944615 | TASK [upload-logs-failover : Initialize control vars] 2026-03-10 00:19:34.962739 | localhost | ok 2026-03-10 00:19:34.967290 | 2026-03-10 00:19:34.967373 | LOOP [upload-logs-failover : Perform log upload] 2026-03-10 00:19:35.032391 | localhost | Output suppressed because no_log was given 2026-03-10 00:19:35.039032 | localhost | included: /var/lib/zuul/builds/eca09c0c94d44ce0a63dc90f7bd50946/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/upload-logs-failover/tasks/upload.yaml 2026-03-10 00:19:35.045967 | 2026-03-10 00:19:35.046089 | LOOP [upload-logs-failover : Unpack vars for swift upload] 2026-03-10 00:19:35.141692 | localhost | Output suppressed because no_log was given 2026-03-10 00:19:35.149104 | 2026-03-10 00:19:35.149221 | TASK [Upload logs to swift] 2026-03-10 00:19:35.170874 | localhost | ok 2026-03-10 00:19:35.197887 | 2026-03-10 00:19:35.198004 | TASK [Set zuul-log-path fact] 2026-03-10 00:19:35.227199 | localhost | skipping: Conditional result was False 2026-03-10 00:19:35.234636 | 2026-03-10 00:19:35.234759 | TASK [upload-logs-swift : Ensure logs are readable before uploading] 2026-03-10 00:19:35.636738 | localhost -> localhost | ok: Runtime: 0:00:00.008818 2026-03-10 00:19:35.649817 | 2026-03-10 00:19:35.650001 | TASK [upload-logs-swift : Upload logs to swift]