2025-10-02 20:53:28.228337 | Job console starting... 2025-10-02 20:53:28.644783 | Updating repositories 2025-10-02 20:53:29.486333 | Preparing job workspace 2025-10-02 20:53:45.433608 | Running Ansible setup... 2025-10-02 20:53:54.116551 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master] 2025-10-02 20:53:56.129430 | 2025-10-02 20:53:56.129542 | PLAY [localhost] 2025-10-02 20:53:56.181700 | 2025-10-02 20:53:56.181804 | TASK [Gathering Facts] 2025-10-02 20:53:59.532609 | localhost | ok 2025-10-02 20:53:59.593409 | 2025-10-02 20:53:59.593519 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2025-10-02 20:54:01.936540 | localhost -> localhost | changed 2025-10-02 20:54:01.942252 | 2025-10-02 20:54:01.942335 | TASK [log-inventory : Copy ansible inventory to logs dir] 2025-10-02 20:54:05.729595 | localhost -> localhost | changed 2025-10-02 20:54:05.739078 | 2025-10-02 20:54:05.739151 | TASK [Setup log path fact] 2025-10-02 20:54:05.809796 | localhost | ok 2025-10-02 20:54:05.848383 | 2025-10-02 20:54:05.848495 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-10-02 20:54:05.952496 | localhost | ok 2025-10-02 20:54:05.977076 | 2025-10-02 20:54:05.977161 | TASK [emit-job-header : Print job information] 2025-10-02 20:54:06.116600 | # Job Information 2025-10-02 20:54:06.116802 | Ansible Version: 2.15.12 2025-10-02 20:54:06.116836 | Job: cifmw-molecule-dlrn_promote 2025-10-02 20:54:06.116859 | Pipeline: github-check 2025-10-02 20:54:06.116881 | Executor: ibm-bm4-ze.softwarefactory-project.io 2025-10-02 20:54:06.116902 | Triggered by: https://github.com/openstack-k8s-operators/ci-framework/pull/3362 2025-10-02 20:54:06.116955 | Log URL (when completed): https://logserver.rdoproject.org/910/rdoproject.org/91035510de66489390b166f373d13924/ 2025-10-02 20:54:06.116979 | Event ID: b3260540-9fd1-11f0-99c1-8299ec1f8fbb 2025-10-02 20:54:06.121046 | 2025-10-02 20:54:06.121118 | LOOP [emit-job-header : Print node information] 2025-10-02 20:54:06.631167 | localhost | ok: 2025-10-02 20:54:06.631362 | localhost | # Node Information 2025-10-02 20:54:06.631394 | localhost | Inventory Hostname: controller 2025-10-02 20:54:06.631420 | localhost | Hostname: np0005467432 2025-10-02 20:54:06.631442 | localhost | Username: zuul 2025-10-02 20:54:06.631464 | localhost | Distro: CentOS 9 2025-10-02 20:54:06.631483 | localhost | Provider: ibm-bm4-nodepool 2025-10-02 20:54:06.631502 | localhost | Region: regionOne 2025-10-02 20:54:06.631520 | localhost | Label: cloud-centos-9-stream-tripleo-ibm 2025-10-02 20:54:06.631538 | localhost | Product Name: OpenStack Compute 2025-10-02 20:54:06.631557 | localhost | Interface IP: 192.168.26.98 2025-10-02 20:54:06.721148 | 2025-10-02 20:54:06.721232 | PLAY [all] 2025-10-02 20:54:06.771226 | 2025-10-02 20:54:06.771315 | TASK [Gather network facts] 2025-10-02 20:54:07.258922 | controller | ok 2025-10-02 20:54:07.316106 | 2025-10-02 20:54:07.316200 | TASK [include_role : start-zuul-console] 2025-10-02 20:54:07.378446 | controller | ok 2025-10-02 20:54:07.415241 | 2025-10-02 20:54:07.415336 | TASK [start-zuul-console : Start zuul_console daemon.] 2025-10-02 20:54:08.445685 | controller | ok 2025-10-02 20:54:08.476756 | 2025-10-02 20:54:08.476846 | TASK [include_role : add-build-sshkey] 2025-10-02 20:54:08.560097 | controller | ok 2025-10-02 20:54:08.634401 | 2025-10-02 20:54:08.634498 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2025-10-02 20:54:09.555004 | controller -> localhost | ok 2025-10-02 20:54:09.560700 | 2025-10-02 20:54:09.560787 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2025-10-02 20:54:09.629613 | controller | ok 2025-10-02 20:54:09.684333 | controller | included: /var/lib/zuul/builds/91035510de66489390b166f373d13924/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2025-10-02 20:54:09.710088 | 2025-10-02 20:54:09.710183 | TASK [add-build-sshkey : Create Temp SSH key] 2025-10-02 20:54:11.887483 | controller -> localhost | Generating public/private rsa key pair. 2025-10-02 20:54:11.887670 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/91035510de66489390b166f373d13924/work/91035510de66489390b166f373d13924_id_rsa. 2025-10-02 20:54:11.887706 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/91035510de66489390b166f373d13924/work/91035510de66489390b166f373d13924_id_rsa.pub. 2025-10-02 20:54:11.887731 | controller -> localhost | The key fingerprint is: 2025-10-02 20:54:11.887752 | controller -> localhost | SHA256:kqYQp3FI5Wi+goAsSo5h0erNb89x3bZlHVz+LgQaD0I zuul-build-sshkey 2025-10-02 20:54:11.887772 | controller -> localhost | The key's randomart image is: 2025-10-02 20:54:11.887791 | controller -> localhost | +---[RSA 3072]----+ 2025-10-02 20:54:11.887809 | controller -> localhost | | ... | 2025-10-02 20:54:11.887828 | controller -> localhost | | ..+ E | 2025-10-02 20:54:11.887846 | controller -> localhost | | .*.+ . .| 2025-10-02 20:54:11.887864 | controller -> localhost | |ooo* .. o . ...| 2025-10-02 20:54:11.887881 | controller -> localhost | |==+ + S. = . o.| 2025-10-02 20:54:11.887900 | controller -> localhost | |@.oo o . o o . +| 2025-10-02 20:54:11.887966 | controller -> localhost | |=o.o. . . . + oo| 2025-10-02 20:54:11.887990 | controller -> localhost | | . ... o . =. | 2025-10-02 20:54:11.888009 | controller -> localhost | | ...o . ..| 2025-10-02 20:54:11.888027 | controller -> localhost | +----[SHA256]-----+ 2025-10-02 20:54:11.888081 | controller -> localhost | ok: Runtime: 0:00:00.299998 2025-10-02 20:54:11.893766 | 2025-10-02 20:54:11.893834 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2025-10-02 20:54:11.953489 | controller | ok 2025-10-02 20:54:12.005031 | controller | included: /var/lib/zuul/builds/91035510de66489390b166f373d13924/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2025-10-02 20:54:12.062377 | 2025-10-02 20:54:12.062474 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2025-10-02 20:54:12.163069 | controller | skipping: Conditional result was False 2025-10-02 20:54:12.168541 | 2025-10-02 20:54:12.168620 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2025-10-02 20:54:13.293481 | controller | changed 2025-10-02 20:54:13.309287 | 2025-10-02 20:54:13.309370 | TASK [add-build-sshkey : Make sure user has a .ssh] 2025-10-02 20:54:13.620732 | controller | ok 2025-10-02 20:54:13.625761 | 2025-10-02 20:54:13.625836 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2025-10-02 20:54:14.504185 | controller | changed 2025-10-02 20:54:14.516858 | 2025-10-02 20:54:14.516969 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2025-10-02 20:54:15.424110 | controller | changed 2025-10-02 20:54:15.433209 | 2025-10-02 20:54:15.433297 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2025-10-02 20:54:15.522192 | controller | skipping: Conditional result was False 2025-10-02 20:54:15.528969 | 2025-10-02 20:54:15.529053 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2025-10-02 20:54:16.943702 | controller -> localhost | changed 2025-10-02 20:54:16.966211 | 2025-10-02 20:54:16.966300 | TASK [add-build-sshkey : Add back temp key] 2025-10-02 20:54:18.205201 | controller -> localhost | Identity added: /var/lib/zuul/builds/91035510de66489390b166f373d13924/work/91035510de66489390b166f373d13924_id_rsa (zuul-build-sshkey) 2025-10-02 20:54:18.205423 | controller -> localhost | ok: Runtime: 0:00:00.030597 2025-10-02 20:54:18.213649 | 2025-10-02 20:54:18.213739 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2025-10-02 20:54:18.811650 | controller | ok 2025-10-02 20:54:18.816846 | 2025-10-02 20:54:18.816948 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2025-10-02 20:54:18.916686 | controller | skipping: Conditional result was False 2025-10-02 20:54:18.926571 | 2025-10-02 20:54:18.926639 | TASK [include_role : validate-host] 2025-10-02 20:54:18.981108 | controller | ok 2025-10-02 20:54:19.035989 | 2025-10-02 20:54:19.036100 | TASK [validate-host : Define zuul_info_dir fact] 2025-10-02 20:54:19.150829 | controller | ok 2025-10-02 20:54:19.155899 | 2025-10-02 20:54:19.155996 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2025-10-02 20:54:20.327513 | controller -> localhost | ok 2025-10-02 20:54:20.334489 | 2025-10-02 20:54:20.334581 | TASK [validate-host : Collect information about the host] 2025-10-02 20:54:21.051300 | controller | ok 2025-10-02 20:54:21.073677 | 2025-10-02 20:54:21.073765 | TASK [validate-host : Sanitize hostname] 2025-10-02 20:54:21.311105 | controller | ok 2025-10-02 20:54:21.321494 | 2025-10-02 20:54:21.321583 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2025-10-02 20:54:23.720895 | controller -> localhost | changed 2025-10-02 20:54:23.726788 | 2025-10-02 20:54:23.726880 | TASK [validate-host : Collect information about zuul worker] 2025-10-02 20:54:24.993148 | controller | ok 2025-10-02 20:54:25.000342 | 2025-10-02 20:54:25.000434 | TASK [validate-host : Write out all zuul information for each host] 2025-10-02 20:54:27.706616 | controller -> localhost | changed 2025-10-02 20:54:27.726566 | 2025-10-02 20:54:27.726657 | TASK [include_role : prepare-workspace-openshift] 2025-10-02 20:54:27.819675 | controller | skipping: Conditional result was False 2025-10-02 20:54:27.825344 | 2025-10-02 20:54:27.825426 | TASK [include_role : remove-zuul-sshkey] 2025-10-02 20:54:27.912439 | controller | skipping: Conditional result was False 2025-10-02 20:54:27.917366 | 2025-10-02 20:54:27.917448 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2025-10-02 20:54:28.279033 | controller | ok: "logs" 2025-10-02 20:54:28.279249 | controller | ok: All items complete 2025-10-02 20:54:28.279281 | 2025-10-02 20:54:28.479972 | controller | ok: "artifacts" 2025-10-02 20:54:28.681879 | controller | ok: "docs" 2025-10-02 20:54:28.690880 | 2025-10-02 20:54:28.690992 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2025-10-02 20:54:29.014453 | controller | changed: "logs" 2025-10-02 20:54:29.199508 | controller | changed: "artifacts" 2025-10-02 20:54:29.400813 | controller | changed: "docs" 2025-10-02 20:54:29.551350 | 2025-10-02 20:54:29.551444 | PLAY RECAP 2025-10-02 20:54:29.551491 | controller | ok: 22 changed: 9 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0 2025-10-02 20:54:29.551521 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-10-02 20:54:29.551541 | 2025-10-02 20:54:30.213694 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master] 2025-10-02 20:54:30.214788 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master] 2025-10-02 20:54:33.677472 | 2025-10-02 20:54:33.677576 | PLAY [all] 2025-10-02 20:54:33.814830 | 2025-10-02 20:54:33.814964 | TASK [mirror-info-fork : Set mirror_fqdn if not defined] 2025-10-02 20:54:34.108260 | controller | ok 2025-10-02 20:54:34.124049 | 2025-10-02 20:54:34.127718 | TASK [mirror-info-fork : Create /etc/ci] 2025-10-02 20:54:35.013638 | controller | changed 2025-10-02 20:54:35.023290 | 2025-10-02 20:54:35.023382 | TASK [mirror-info-fork : Install ci_mirror script] 2025-10-02 20:54:37.486985 | controller | changed 2025-10-02 20:54:37.521429 | 2025-10-02 20:54:37.521552 | LOOP [add-authorized-keys : Enable access via build key on all nodes] 2025-10-02 20:54:38.434760 | controller | changed: 2025-10-02 20:54:38.439002 | controller | { 2025-10-02 20:54:38.439120 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAABIwAAAQEA4Z/c9osaGGtU6X8fgELwfj/yayRurfcKA0HMFfdpPxev2dbwljysMuzoVp4OZmW1gvGtyYPSNRvnzgsaabPNKNo2ym5NToCP6UM+KSe93aln4BcM/24mXChYAbXJQ5Bqq/pIzsGs/pKetQN+vwvMxLOwTvpcsCJBXaa981RKML6xj9l/UZ7IIq1HSEKMvPLxZMWdu0Ut8DkCd5F4nOw9Wgml2uYpDCj5LLCrQQ9ChdOMz8hz6SighhNlRpPkvPaet3OXxr/ytFMu7j7vv06CaEnuMMiY2aTWN1Imin9eHAylIqFHta/3gFfQSWt9jXM7owkBLKL7ATzhaAn+fjNupw== arxcruz@redhat.com" 2025-10-02 20:54:38.439160 | controller | } 2025-10-02 20:54:38.662759 | controller | changed: 2025-10-02 20:54:38.662850 | controller | { 2025-10-02 20:54:38.662880 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDS4Fn6k4deCnIlOtLWqZJyksbepjQt04j8Ed8CGx9EKkj0fKiAxiI4TadXQYPuNHMixZy4Nevjb6aDhL5Z906TfvNHKUrjrG7G26a0k8vdc61NEQ7FmcGMWRLwwc6ReDO7lFpzYKBMk4YqfWgBuGU/K6WLKiVW2cVvwIuGIaYrE1OiiX0iVUUk7KApXlDJMXn7qjSYynfO4mF629NIp8FJal38+Kv+HA+0QkE5Y2xXnzD4Lar5+keymiCHRntPppXHeLIRzbt0gxC7v3L72hpQ3BTBEzwHpeS8KY+SX1y5lRMN45thCHfJqGmARJREDjBvWG8JXOPmVIKQtZmVcD5b mandreou@redhat.com" 2025-10-02 20:54:38.662903 | controller | } 2025-10-02 20:54:38.907547 | controller | changed: 2025-10-02 20:54:38.907704 | controller | { 2025-10-02 20:54:38.907744 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC9MiLfy30deHA7xPOAlew5qUq3UP2gmRMYJi8PtkjFB20/DKeWwWNnkZPqP9AayruRoo51SIiVg870gbZE2jYl+Ncx/FYDe56JeC3ySZsXoAVkC9bP7gkOGqOmJjirvAgPMI7bogVz8i+66Q4Ar7OKTp3762G4IuWPPEg4ce4Y7lx9qWocZapHYq4cYKMxrOZ7SEbFSATBbe2bPZAPKTw8do/Eny+Hq/LkHFhIeyra6cqTFQYShr+zPln0Cr+ro/pDX3bB+1ubFgTpjpkkkQsLhDfR6cCdCWM2lgnS3BTtYj5Ct9/JRPR5YOphqZz+uB+OEu2IL68hmU9vNTth1KeX rlandy@redhat.com" 2025-10-02 20:54:38.907770 | controller | } 2025-10-02 20:54:39.172452 | controller | changed: 2025-10-02 20:54:39.172530 | controller | { 2025-10-02 20:54:39.172560 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIFCbgz8gdERiJlk2IKOtkjQxEXejrio6ZYMJAVJYpOIp raukadah@gmail.com" 2025-10-02 20:54:39.172582 | controller | } 2025-10-02 20:54:39.408022 | controller | changed: 2025-10-02 20:54:39.408105 | controller | { 2025-10-02 20:54:39.408134 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIBqb3Q/9uDf4LmihQ7xeJ9gA/STIQUFPSfyyV0m8AoQi bshewale@redhat.com" 2025-10-02 20:54:39.408157 | controller | } 2025-10-02 20:54:39.654870 | controller | changed: 2025-10-02 20:54:39.655032 | controller | { 2025-10-02 20:54:39.655077 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC0I8QqQx0Az2ysJt2JuffucLijhBqnsXKEIx5GyHwxVULROa8VtNFXUDH6ZKZavhiMcmfHB2+TBTda+lDP4FldYj06dGmzCY+IYGa+uDRdxHNGYjvCfLFcmLlzRK6fNbTcui+KlUFUdKe0fb9CRoGKyhlJD5GRkM1Dv+Yb6Bj+RNnmm1fVGYxzmrD2utvffYEb0SZGWxq2R9gefx1q/3wCGjeqvufEV+AskPhVGc5T7t9eyZ4qmslkLh1/nMuaIBFcr9AUACRajsvk6mXrAN1g3HlBf2gQlhi1UEyfbqIQvzzFtsbLDlSum/KmKjy818GzvWjERfQ0VkGzCd9bSLVL dviroel@redhat.com" 2025-10-02 20:54:39.655125 | controller | } 2025-10-02 20:54:40.089977 | controller | changed: 2025-10-02 20:54:40.090071 | controller | { 2025-10-02 20:54:40.090101 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQDLOQd4ZLtkZXQGY6UwAr/06ppWQK4fDO3HaqxPk98csyOCBXsliSKK39Bso828+5srIXiW7aI6aC9P5mwi4mUZlGPfJlQbfrcGvY+b/SocuvaGK+1RrHLoJCT52LBhwgrzlXio2jeksZeein8iaTrhsPrOAs7KggIL/rB9hEiB3NaOPWhhoCP4vlW6MEMExGcqB/1FVxXFBPnLkEyW0Lk7ycVflZl2ocRxbfjZi0+tI1Wlinp8PvSQSc/WVrAcDgKjc/mB4ODPOyYy3G8FHgfMsrXSDEyjBKgLKMsdCrAUcqJQWjkqXleXSYOV4q3pzL+9umK+q/e3P/bIoSFQzmJKTU1eDfuvPXmow9F5H54fii/Da7ezlMJ+wPGHJrRAkmzvMbALy7xwswLhZMkOGNtRcPqaKYRmIBKpw3o6bCTtcNUHOtOQnzwY8JzrM2eBWJBXAANYw+9/ho80JIiwhg29CFNpVBuHbql2YxJQNrnl90guN65rYNpDxdIluweyUf8= anbanerj@kaermorhen" 2025-10-02 20:54:40.090125 | controller | } 2025-10-02 20:54:40.145290 | controller | changed: 2025-10-02 20:54:40.145355 | controller | { 2025-10-02 20:54:40.145384 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQC3VwV8Im9kRm49lt3tM36hj4Zv27FxGo4C1Q/0jqhzFmHY7RHbmeRr8ObhwWoHjXSozKWg8FL5ER0z3hTwL0W6lez3sL7hUaCmSuZmG5Hnl3x4vTSxDI9JZ/Y65rtYiiWQo2fC5xJhU/4+0e5e/pseCm8cKRSu+SaxhO+sd6FDojA2x1BzOzKiQRDy/1zWGp/cZkxcEuB1wHI5LMzN03c67vmbu+fhZRAUO4dQkvcnj2LrhQtpa+ytvnSjr8icMDosf1OsbSffwZFyHB/hfWGAfe0eIeSA2XPraxiPknXxiPKx2MJsaUTYbsZcm3EjFdHBBMumw5rBI74zLrMRvCO9GwBEmGT4rFng1nP+yw5DB8sn2zqpOsPg1LYRwCPOUveC13P6pgsZZPh812e8v5EKnETct+5XI3dVpdw6CnNiLwAyVAF15DJvBGT/u1k0Myg/bQn+Gv9k2MSj6LvQmf6WbZu2Wgjm30z3FyCneBqTL7mLF19YXzeC0ufHz5pnO1E= dasm@fedora" 2025-10-02 20:54:40.145407 | controller | } 2025-10-02 20:54:40.406366 | controller | changed: 2025-10-02 20:54:40.406484 | controller | { 2025-10-02 20:54:40.406539 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIHUnwjB20UKmsSed9X73eGNV5AOEFccQ3NYrRW776pEk cjeanner" 2025-10-02 20:54:40.406564 | controller | } 2025-10-02 20:54:40.659395 | controller | changed: 2025-10-02 20:54:40.659471 | controller | { 2025-10-02 20:54:40.659498 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDercCMGn8rW1C4P67tHgtflPdTeXlpyUJYH+6XDd2lR jgilaber@redhat.com" 2025-10-02 20:54:40.659519 | controller | } 2025-10-02 20:54:40.957636 | controller | changed: 2025-10-02 20:54:40.957722 | controller | { 2025-10-02 20:54:40.957757 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIAMI6kkg9Wg0sG7jIJmyZemEBwUn1yzNpQQd3gnulOmZ adrianfuscoarnejo@gmail.com" 2025-10-02 20:54:40.957785 | controller | } 2025-10-02 20:54:41.198575 | controller | changed: 2025-10-02 20:54:41.198660 | controller | { 2025-10-02 20:54:41.198689 | controller | "public_key": "ecdsa-sha2-nistp256 AAAAE2VjZHNhLXNoYTItbmlzdHAyNTYAAAAIbmlzdHAyNTYAAABBBPijwpQu/3jhhhBZInXNOLEH57DrknPc3PLbsRvYyJIFzwYjX+WD4a7+nGnMYS42MuZk6TJcVqgnqofVx4isoD4= ramishra@redhat.com" 2025-10-02 20:54:41.198712 | controller | } 2025-10-02 20:54:41.432293 | controller | changed: 2025-10-02 20:54:41.432377 | controller | { 2025-10-02 20:54:41.432406 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIGpU/BepK3qX0NRf5Np+dOBDqzQEefhNrw2DCZaH3uWW rebtoor@monolith" 2025-10-02 20:54:41.432427 | controller | } 2025-10-02 20:54:41.671160 | controller | changed: 2025-10-02 20:54:41.671251 | controller | { 2025-10-02 20:54:41.671280 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDK0iKdi8jQTpQrDdLVH/AAgLVYyTXF7AQ1gjc/5uT3t ykarel@yatinkarel" 2025-10-02 20:54:41.671301 | controller | } 2025-10-02 20:54:41.950274 | controller | changed: 2025-10-02 20:54:41.950358 | controller | { 2025-10-02 20:54:41.950386 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIF/V/cLotA6LZeO32VL45Hd78skuA2lJA425Sm2LlQeZ fmount@horcrux" 2025-10-02 20:54:41.950407 | controller | } 2025-10-02 20:54:42.184985 | controller | changed: 2025-10-02 20:54:42.185071 | controller | { 2025-10-02 20:54:42.185102 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDa7QCjuDMVmRPo1rREbGwzYeBCYVN+Ou/3WKXZEC6Sr" 2025-10-02 20:54:42.185124 | controller | } 2025-10-02 20:54:42.425227 | controller | changed: 2025-10-02 20:54:42.426425 | controller | { 2025-10-02 20:54:42.426486 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAACAQCfNtF7NvKl915TGsGGoseUb06Hj8L/S4toWf0hExeY+F00woL6NvBlJD0nDct+P5a22I4EhvoQCRQ8reaPCm1lybR3uiRIJsj+8zkVvLwby9LXzfZorlNG9ofjd00FEmB09uW/YvTl6Q9XwwwX6tInzIOv3TMqTHHGOL74ibbj8J/FJR0cFEyj0z4WQRvtkh32xAHl83gbuINryMt0sqRI+clj2381NKL55DRLQrVw0gsfqqxiHAnXg21qWmc4J+b9e9kiuAFQjcjwTVkwJCcg3xbPwC/qokYRby/Y5S40UUd7/jEARGXT7RZgpzTuDd1oZiCVrnrqJNPaMNdVv5MLeFdf1B7iIe5aa/fGouX7AO4SdKhZUdnJmCFAGvjC6S3JMZ2wAcUl+OHnssfmdj7XL50cLo27vjuzMtLAgSqi6N99m92WCF2s8J9aVzszX7Xz9OKZCeGsiVJp3/NdABKzSEAyM9xBD/5Vho894Sav+otpySHe3p6RUTgbB5Zu8VyZRZ/UtB3ueXxyo764yrc6qWIDqrehm84Xm9g+/jpIBzGPl07NUNJpdt/6Sgf9RIKXw/7XypO5yZfUcuFNGTxLfqjTNrtgLZNcjfav6sSdVXVcMPL//XNuRdKmVFaO76eV/oGMQGr1fGcCD+N+CpI7+Q+fCNB6VFWG4nZFuI/Iuw== averdagu@redhat.com" 2025-10-02 20:54:42.426515 | controller | } 2025-10-02 20:54:42.650816 | controller | changed: 2025-10-02 20:54:42.650903 | controller | { 2025-10-02 20:54:42.650963 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQDq8l27xI+QlQVdS4djp9ogSoyrNE2+Ox6vKPdhSNL1J3PE5w+WCSvMz9A5gnNuH810zwbekEApbxTze/gLQJwBHA52CChfURpXrFaxY7ePXRElwKAL3mJfzBWY/c5jnNL9TCVmFJTGZkFZP3Nh+BMgZvL6xBkt3WKm6Uq18qzd9XeKcZusrA+O+uLv1fVeQnadY9RIqOCyeFYCzLWrUfTyE8x/XG0hAWIM7qpnF2cALQS2h9n4hW5ybiUN790H08wf9hFwEf5nxY9Z9dVkPFQiTSGKNBzmnCXU9skxS/xhpFjJ5duGSZdtAHe9O+nGZm9c67hxgtf8e5PDuqAdXEv2cf6e3VBAt+Bz8EKI3yosTj0oZHfwr42Yzb1l/SKy14Rggsrc9KAQlrGXan6+u2jcQqqx7l+SWmnpFiWTV9u5cWj2IgOhApOitmRBPYqk9rE2usfO0hLn/Pj/R/Nau4803e1/EikdLE7Ps95s9mX5jRDjAoUa2JwFF5RsVFyL910= ashigupt@ashigupt.remote.csb" 2025-10-02 20:54:42.650995 | controller | } 2025-10-02 20:54:42.891414 | controller | changed: 2025-10-02 20:54:42.891547 | controller | { 2025-10-02 20:54:42.891579 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIOKLl0NYKwoZ/JY5KeZU8VwRAggeOxqQJeoqp3dsAaY9" 2025-10-02 20:54:42.891600 | controller | } 2025-10-02 20:54:43.146766 | controller | changed: 2025-10-02 20:54:43.146844 | controller | { 2025-10-02 20:54:43.146875 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIASASQOH2BcOyLKuuDOdWZlPi2orcjcA8q4400T73DLH evallesp@fedora" 2025-10-02 20:54:43.146897 | controller | } 2025-10-02 20:54:43.386346 | controller | changed: 2025-10-02 20:54:43.386433 | controller | { 2025-10-02 20:54:43.386462 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAILeBWlamUph+jRKV2qrx1PGU7vWuGIt5+z9k96I8WehW amsinha@amsinha-mac" 2025-10-02 20:54:43.386483 | controller | } 2025-10-02 20:54:43.623212 | controller | changed: 2025-10-02 20:54:43.623302 | controller | { 2025-10-02 20:54:43.623331 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIANvVgvJBlK3gb1yz5uef/JqIGq4HLEmY2dYA8e37swb morenod@redhat-laptop" 2025-10-02 20:54:43.623354 | controller | } 2025-10-02 20:54:43.886176 | controller | changed: 2025-10-02 20:54:43.886250 | controller | { 2025-10-02 20:54:43.886287 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAACAQDZdI7t1cxYx65heVI24HTV4F7oQLW1zyfxHreL2TIJKxjyrUUKIFEUmTutcBlJRLNT2Eoix6x1sOw9YrchloCLcn//SGfTElr9mSc5jbjb7QXEU+zJMhtxyEJ1Po3CUGnj7ckiIXw7wcawZtrEOAQ9pH3ExYCJcEMiyNjRQZCxT3tPK+S4B95EWh5Fsrz9CkwpjNRPPH7LigCeQTM3Wc7r97utAslBUUvYceDSLA7rMgkitJE38b7rZBeYzsGQ8YYUBjTCtehqQXxCRjizbHWaaZkBU+N3zkKB6n/iCNGIO690NK7A/qb6msTijiz1PeuM8ThOsi9qXnbX5v0PoTpcFSojV7NHAQ71f0XXuS43FhZctT+Dcx44dT8Fb5vJu2cJGrk+qF8ZgJYNpRS7gPg0EG2EqjK7JMf9ULdjSu0r+KlqIAyLvtzT4eOnQipoKlb/WG5D/0ohKv7OMQ352ggfkBFIQsRXyyTCT98Ft9juqPuahi3CAQmP4H9dyE+7+Kz437PEtsxLmfm6naNmWi7Ee1DqWPwS8rEajsm4sNM4wW9gdBboJQtc0uZw0DfLj1I9r3Mc8Ol0jYtz0yNQDSzVLrGCaJlC311trU70tZ+ZkAVV6Mn8lOhSbj1cK0lvSr6ZK4dgqGl3I1eTZJJhbLNdg7UOVaiRx9543+C/p/As7w== brjackma@redhat.com" 2025-10-02 20:54:43.886312 | controller | } 2025-10-02 20:54:44.132720 | controller | changed: 2025-10-02 20:54:44.132804 | controller | { 2025-10-02 20:54:44.132835 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIKwedoZ0TWPJX/z/4TAbO/kKcDZOQVgRH0hAqrL5UCI1 vcastell@redhat.com" 2025-10-02 20:54:44.132856 | controller | } 2025-10-02 20:54:44.397424 | controller | changed: 2025-10-02 20:54:44.397506 | controller | { 2025-10-02 20:54:44.397536 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIEmv8sE8GCk6ZTPIqF0FQrttBdL3mq7rCm/IJy0xDFh7 michburk@redhat.com" 2025-10-02 20:54:44.397558 | controller | } 2025-10-02 20:54:44.650274 | controller | changed: 2025-10-02 20:54:44.650363 | controller | { 2025-10-02 20:54:44.650394 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAICy6GpGEtwevXEEn4mmLR5lmSLe23dGgAvzkB9DMNbkf rsafrono@rsafrono" 2025-10-02 20:54:44.650416 | controller | } 2025-10-02 20:54:44.716787 | 2025-10-02 20:54:44.716897 | TASK [Set timezone to UTC] 2025-10-02 20:54:45.583278 | controller | changed: executed `/bin/timedatectl set-timezone UTC` 2025-10-02 20:54:45.595500 | 2025-10-02 20:54:45.595583 | TASK [Create nodepool directory] 2025-10-02 20:54:45.914250 | controller | changed 2025-10-02 20:54:45.937939 | 2025-10-02 20:54:45.938029 | TASK [Create nodepool sub_nodes file] 2025-10-02 20:54:46.755664 | controller | changed 2025-10-02 20:54:46.763997 | 2025-10-02 20:54:46.764090 | TASK [Create nodepool sub_nodes_private file] 2025-10-02 20:54:47.620558 | controller | changed 2025-10-02 20:54:47.626253 | 2025-10-02 20:54:47.626328 | LOOP [Populate nodepool sub_nodes file] 2025-10-02 20:54:47.738586 | 2025-10-02 20:54:47.738757 | LOOP [Populate nodepool sub_nodes_private file] 2025-10-02 20:54:47.841969 | 2025-10-02 20:54:47.842127 | TASK [Create nodepool primary file] 2025-10-02 20:54:47.940261 | controller | skipping: Conditional result was False 2025-10-02 20:54:47.946017 | 2025-10-02 20:54:47.946120 | TASK [Create nodepool node_private for this node] 2025-10-02 20:54:48.778509 | controller | changed 2025-10-02 20:54:48.784162 | 2025-10-02 20:54:48.784241 | LOOP [Copy ssh keys to nodepool directory] 2025-10-02 20:54:49.942075 | controller | ok: Item: id_rsa Runtime: 0:00:00.005676 2025-10-02 20:54:49.942267 | 2025-10-02 20:54:50.129633 | controller | ok: Item: id_rsa.pub Runtime: 0:00:00.004641 2025-10-02 20:54:50.150279 | 2025-10-02 20:54:50.150380 | TASK [Add sudoers role for zuul-sudo-grep.sh] 2025-10-02 20:54:50.966964 | controller | changed 2025-10-02 20:54:50.977339 | 2025-10-02 20:54:50.977422 | TASK [Validate sudoers config after edits] 2025-10-02 20:54:51.440341 | controller | /etc/sudoers: parsed OK 2025-10-02 20:54:51.440432 | controller | /etc/sudoers.d/90-cloud-init-users: parsed OK 2025-10-02 20:54:51.440460 | controller | /etc/sudoers.d/zuul: parsed OK 2025-10-02 20:54:51.440467 | controller | /etc/sudoers.d/zuul-sudo-grep: parsed OK 2025-10-02 20:54:51.567683 | controller | ok: Runtime: 0:00:00.004732 2025-10-02 20:54:51.573262 | 2025-10-02 20:54:51.573330 | TASK [Show the environment passed in to job shell scripts] 2025-10-02 20:54:52.066025 | controller | SHELL=/bin/bash 2025-10-02 20:54:52.066072 | controller | ZUUL_PROJECT=openstack-k8s-operators/ci-framework 2025-10-02 20:54:52.066081 | controller | ZUUL_SHORT_PROJECT_NAME=ci-framework 2025-10-02 20:54:52.066087 | controller | ZUUL_CHANGES=openstack-k8s-operators/ci-framework:main:refs/changes/62/3362/41f2edaa0ac45cd85919f70775e84cf472326a6e 2025-10-02 20:54:52.066094 | controller | PWD=/home/zuul 2025-10-02 20:54:52.066100 | controller | ZUUL_PIPELINE=github-check 2025-10-02 20:54:52.066105 | controller | LOGNAME=zuul 2025-10-02 20:54:52.066110 | controller | XDG_SESSION_TYPE=tty 2025-10-02 20:54:52.066116 | controller | _=/usr/bin/env 2025-10-02 20:54:52.066156 | controller | MOTD_SHOWN=pam 2025-10-02 20:54:52.066164 | controller | HOME=/home/zuul 2025-10-02 20:54:52.066169 | controller | LANG=en_US.UTF-8 2025-10-02 20:54:52.066175 | controller | SSH_CONNECTION=192.168.26.12 36710 192.168.26.98 22 2025-10-02 20:54:52.066181 | controller | TOX_TESTENV_PASSENV=ZUUL_UUID ZUUL_PROJECT ZUUL_SHORT_PROJECT_NAME ZUUL_PIPELINE ZUUL_VOTING WORKSPACE BUILD_TIMEOUT ZUUL_BRANCH ZUUL_CHANGES ZUUL_CHANGE_IDS ZUUL_CHANGE ZUUL_PATCHSET 2025-10-02 20:54:52.066189 | controller | ZUUL_CHANGE_IDS=3362,41f2edaa0ac45cd85919f70775e84cf472326a6e 2025-10-02 20:54:52.066194 | controller | WORKSPACE=/home/zuul/workspace 2025-10-02 20:54:52.066200 | controller | XDG_SESSION_CLASS=user 2025-10-02 20:54:52.066205 | controller | SELINUX_ROLE_REQUESTED= 2025-10-02 20:54:52.066211 | controller | LESSOPEN=||/usr/bin/lesspipe.sh %s 2025-10-02 20:54:52.066216 | controller | USER=zuul 2025-10-02 20:54:52.066221 | controller | ZUUL_VOTING=True 2025-10-02 20:54:52.066226 | controller | BUILD_TIMEOUT=1800000 2025-10-02 20:54:52.066232 | controller | SELINUX_USE_CURRENT_RANGE= 2025-10-02 20:54:52.066237 | controller | SHLVL=1 2025-10-02 20:54:52.066242 | controller | ZUUL_PATCHSET=41f2edaa0ac45cd85919f70775e84cf472326a6e 2025-10-02 20:54:52.066248 | controller | XDG_SESSION_ID=1 2025-10-02 20:54:52.066253 | controller | ZUUL_BRANCH=main 2025-10-02 20:54:52.066258 | controller | XDG_RUNTIME_DIR=/run/user/1000 2025-10-02 20:54:52.066264 | controller | SSH_CLIENT=192.168.26.12 36710 22 2025-10-02 20:54:52.066269 | controller | DEBUGINFOD_URLS=https://debuginfod.centos.org/ 2025-10-02 20:54:52.066274 | controller | DEBUGINFOD_IMA_CERT_PATH=/etc/keys/ima: 2025-10-02 20:54:52.066280 | controller | which_declare=declare -f 2025-10-02 20:54:52.066285 | controller | PATH=/home/zuul/.local/bin:/home/zuul/bin:/usr/local/bin:/usr/bin:/usr/local/sbin:/usr/sbin 2025-10-02 20:54:52.066291 | controller | SELINUX_LEVEL_REQUESTED= 2025-10-02 20:54:52.066296 | controller | ZUUL_CHANGE=3362 2025-10-02 20:54:52.066301 | controller | DBUS_SESSION_BUS_ADDRESS=unix:path=/run/user/1000/bus 2025-10-02 20:54:52.066307 | controller | ZUUL_UUID=91035510de66489390b166f373d13924 2025-10-02 20:54:52.066312 | controller | BASH_FUNC_which%%=() { ( alias; 2025-10-02 20:54:52.066319 | controller | eval ${which_declare} ) | /usr/bin/which --tty-only --read-alias --read-functions --show-tilde --show-dot $@ 2025-10-02 20:54:52.066324 | controller | } 2025-10-02 20:54:52.170988 | controller | ok: Runtime: 0:00:00.005508 2025-10-02 20:54:52.186983 | 2025-10-02 20:54:52.187050 | TASK [Workaround hardcoded /home/zuul/workspace in zuul_legacy_vars] 2025-10-02 20:54:52.251960 | controller | skipping: Conditional result was False 2025-10-02 20:54:52.258932 | 2025-10-02 20:54:52.259015 | TASK [Symlink /home/zuul-worker/workspace] 2025-10-02 20:54:53.010608 | controller | skipping: Conditional result was False 2025-10-02 20:54:53.016956 | 2025-10-02 20:54:53.017040 | TASK [Ensure legacy workspace directory] 2025-10-02 20:54:53.270150 | controller | changed 2025-10-02 20:54:53.381441 | 2025-10-02 20:54:53.381536 | PLAY RECAP 2025-10-02 20:54:53.381598 | controller | ok: 14 changed: 11 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0 2025-10-02 20:54:53.381622 | 2025-10-02 20:54:54.076556 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master] 2025-10-02 20:54:54.077377 | PRE-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/dump_zuul_data.yml@main] 2025-10-02 20:54:56.724893 | 2025-10-02 20:54:56.725030 | PLAY [Run ci/playbooks/dump_zuul_data.yml] 2025-10-02 20:54:56.827626 | 2025-10-02 20:54:56.827745 | TASK [Create zuul-output directory] 2025-10-02 20:54:57.713284 | controller | changed 2025-10-02 20:54:57.723279 | 2025-10-02 20:54:57.723379 | TASK [Slurp Zuul inventory test] 2025-10-02 20:54:59.010202 | controller -> localhost | ok 2025-10-02 20:54:59.017944 | 2025-10-02 20:54:59.022471 | TASK [Save zuul inventory] 2025-10-02 20:55:00.885746 | controller | changed 2025-10-02 20:55:00.895581 | 2025-10-02 20:55:00.895668 | TASK [Save zuul vars without the change_message] 2025-10-02 20:55:01.938980 | controller | changed 2025-10-02 20:55:02.028948 | 2025-10-02 20:55:02.029043 | PLAY RECAP 2025-10-02 20:55:02.029098 | controller | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2025-10-02 20:55:02.029123 | 2025-10-02 20:55:02.335302 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/dump_zuul_data.yml@main] 2025-10-02 20:55:02.336064 | PRE-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-prepare.yml@main] 2025-10-02 20:55:04.393753 | 2025-10-02 20:55:04.393887 | PLAY [Run ci/playbooks/molecule-prepare.yml] 2025-10-02 20:55:04.457454 | 2025-10-02 20:55:04.457575 | TASK [Execute mirror info role to configure /etc/ci/mirror_info.sh] 2025-10-02 20:55:04.521656 | controller | ok 2025-10-02 20:55:04.574178 | 2025-10-02 20:55:04.574294 | TASK [mirror-info-fork : Set mirror_fqdn if not defined] 2025-10-02 20:55:04.671558 | controller | skipping: Conditional result was False 2025-10-02 20:55:04.677426 | 2025-10-02 20:55:04.677507 | TASK [mirror-info-fork : Create /etc/ci] 2025-10-02 20:55:05.606367 | controller | ok 2025-10-02 20:55:05.626624 | 2025-10-02 20:55:05.626726 | TASK [mirror-info-fork : Install ci_mirror script] 2025-10-02 20:55:06.664348 | controller | ok 2025-10-02 20:55:06.690478 | 2025-10-02 20:55:06.690589 | TASK [Prepare workspace] 2025-10-02 20:55:06.754571 | controller | ok 2025-10-02 20:55:06.853687 | 2025-10-02 20:55:06.853802 | TASK [prepare-workspace : Start zuul_console daemon.] 2025-10-02 20:55:07.521576 | controller | ok 2025-10-02 20:55:07.529571 | 2025-10-02 20:55:07.529666 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2025-10-02 20:55:11.181788 | controller | Output suppressed because no_log was given 2025-10-02 20:55:11.206464 | 2025-10-02 20:55:11.206622 | LOOP [Create zuul-output directory] 2025-10-02 20:55:11.437086 | controller | changed: "/home/zuul/ci-framework-data/logs" 2025-10-02 20:55:11.643735 | controller | ok: "/home/zuul/zuul-output/logs" 2025-10-02 20:55:11.652231 | 2025-10-02 20:55:11.652333 | TASK [Install required packages] 2025-10-02 20:56:00.780153 | controller | changed 2025-10-02 20:56:00.785719 | 2025-10-02 20:56:00.785804 | TASK [Install venv] 2025-10-02 20:57:03.491973 | controller | changed 2025-10-02 20:57:03.517732 | 2025-10-02 20:57:03.517800 | PLAY RECAP 2025-10-02 20:57:03.517843 | controller | ok: 7 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2025-10-02 20:57:03.517866 | 2025-10-02 20:57:03.597675 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-prepare.yml@main] 2025-10-02 20:57:03.598519 | RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-test.yml@main] 2025-10-02 20:57:04.138500 | 2025-10-02 20:57:04.138670 | PLAY [Run ci/playbooks/molecule-test.yml] 2025-10-02 20:57:04.159758 | 2025-10-02 20:57:04.159849 | TASK [Gather required facts] 2025-10-02 20:57:04.655872 | controller | ok 2025-10-02 20:57:04.661376 | 2025-10-02 20:57:04.661477 | TASK [Load environment var if instructed to] 2025-10-02 20:57:04.685537 | controller | skipping: Conditional result was False 2025-10-02 20:57:04.691427 | 2025-10-02 20:57:04.691532 | TASK [Run molecule] 2025-10-02 20:57:05.627500 | controller | INFO Found config file /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/.config/molecule/config.yml 2025-10-02 20:57:05.761697 | controller | INFO Performing prerun with role_name_check=0... 2025-10-02 20:57:22.540292 | controller | WARNING Another version of '@NAMESPACE@.@NAME@' 3.1.4 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 3.1.4 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.540773 | controller | WARNING Another version of 'ansible.netcommon' 7.1.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 7.1.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.541224 | controller | WARNING Another version of 'ansible.posix' 1.6.2 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.6.2 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.541698 | controller | WARNING Another version of 'ansible.utils' 5.1.2 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 5.1.2 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.542163 | controller | WARNING Another version of 'cifmw.general' 1.0.0+41f2edaa was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.0.0+41f2edaa (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.542653 | controller | WARNING Another version of 'cisco.ios' 9.0.3 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 9.0.3 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.543080 | controller | WARNING Another version of 'community.crypto' 2.22.3 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 2.22.3 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.543550 | controller | WARNING Another version of 'community.general' 10.0.1 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 10.0.1 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.543982 | controller | WARNING Another version of 'community.libvirt' 1.3.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.3.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.544426 | controller | WARNING Another version of 'community.okd' 4.0.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 4.0.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.544897 | controller | WARNING Another version of 'containers.podman' 1.16.2 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.16.2 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.545335 | controller | WARNING Another version of 'junipernetworks.junos' 9.1.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 9.1.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.545786 | controller | WARNING Another version of 'kubernetes.core' 5.0.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 5.0.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.546216 | controller | WARNING Another version of 'mellanox.onyx' 1.0.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.0.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.546683 | controller | WARNING Another version of 'openstack.config_template' 2.1.1 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 2.1.1 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:57:22.555965 | controller | INFO Running check_criteria > prepare 2025-10-02 20:57:23.215373 | controller | 2025-10-02 20:57:23.215476 | controller | PLAY [Prepare] ***************************************************************** 2025-10-02 20:57:23.215490 | controller | 2025-10-02 20:57:23.215500 | controller | TASK [Gathering Facts] ********************************************************* 2025-10-02 20:57:24.045572 | controller | Thursday 02 October 2025 20:57:23 +0000 (0:00:00.012) 0:00:00.012 ****** 2025-10-02 20:57:24.045613 | controller | ok: [instance] 2025-10-02 20:57:24.045655 | controller | 2025-10-02 20:57:24.045805 | controller | TASK [test_deps : Gather facts if they don't exist] **************************** 2025-10-02 20:57:24.045925 | controller | Thursday 02 October 2025 20:57:24 +0000 (0:00:00.832) 0:00:00.844 ****** 2025-10-02 20:57:24.062726 | controller | skipping: [instance] 2025-10-02 20:57:24.062835 | controller | 2025-10-02 20:57:24.062951 | controller | TASK [test_deps : Gather variables for each operating system] ****************** 2025-10-02 20:57:24.063054 | controller | Thursday 02 October 2025 20:57:24 +0000 (0:00:00.017) 0:00:00.862 ****** 2025-10-02 20:57:24.103759 | controller | ok: [instance] => (item=/home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/test_deps/vars/centos-9.yml) 2025-10-02 20:57:24.103880 | controller | 2025-10-02 20:57:24.104003 | controller | TASK [test_deps : Detect mirrors file] ***************************************** 2025-10-02 20:57:24.104109 | controller | Thursday 02 October 2025 20:57:24 +0000 (0:00:00.040) 0:00:00.902 ****** 2025-10-02 20:57:24.383458 | controller | ok: [instance] 2025-10-02 20:57:24.383539 | controller | 2025-10-02 20:57:24.383648 | controller | TASK [test_deps : Disable ubi host subscription-manager integration] *********** 2025-10-02 20:57:24.383751 | controller | Thursday 02 October 2025 20:57:24 +0000 (0:00:00.279) 0:00:01.182 ****** 2025-10-02 20:57:24.694219 | controller | ok: [instance] 2025-10-02 20:57:24.694301 | controller | 2025-10-02 20:57:24.694479 | controller | TASK [test_deps : Disable ubi 9 repos] ***************************************** 2025-10-02 20:57:24.694598 | controller | Thursday 02 October 2025 20:57:24 +0000 (0:00:00.310) 0:00:01.493 ****** 2025-10-02 20:57:25.394997 | controller | ok: [instance] => (item=ubi-9-appstream) 2025-10-02 20:57:25.395046 | controller | ok: [instance] => (item=ubi-9-baseos) 2025-10-02 20:57:25.395147 | controller | ok: [instance] => (item=ubi-9-codeready-builder) 2025-10-02 20:57:25.395242 | controller | 2025-10-02 20:57:25.395357 | controller | TASK [Deploy repo-setup] ******************************************************* 2025-10-02 20:57:25.395492 | controller | Thursday 02 October 2025 20:57:25 +0000 (0:00:00.700) 0:00:02.194 ****** 2025-10-02 20:57:25.452506 | controller | 2025-10-02 20:57:25.452634 | controller | TASK [repo_setup : Ensure directories are present] ***************************** 2025-10-02 20:57:25.452746 | controller | Thursday 02 October 2025 20:57:25 +0000 (0:00:00.057) 0:00:02.251 ****** 2025-10-02 20:57:25.988115 | controller | changed: [instance] => (item=tmp) 2025-10-02 20:57:25.988190 | controller | changed: [instance] => (item=artifacts/repositories) 2025-10-02 20:57:25.988294 | controller | changed: [instance] => (item=venv/repo_setup) 2025-10-02 20:57:25.988402 | controller | 2025-10-02 20:57:25.988537 | controller | TASK [repo_setup : Make sure git-core package is installed] ******************** 2025-10-02 20:57:25.988632 | controller | Thursday 02 October 2025 20:57:25 +0000 (0:00:00.535) 0:00:02.787 ****** 2025-10-02 20:57:26.770487 | controller | ok: [instance] 2025-10-02 20:57:26.770823 | controller | 2025-10-02 20:57:27.921253 | controller | TASK [repo_setup : Get repo-setup repository] ********************************** 2025-10-02 20:57:27.921282 | controller | Thursday 02 October 2025 20:57:26 +0000 (0:00:00.782) 0:00:03.569 ****** 2025-10-02 20:57:27.921294 | controller | changed: [instance] 2025-10-02 20:57:35.909844 | controller | 2025-10-02 20:57:35.909880 | controller | TASK [repo_setup : Initialize python venv and install requirements] ************ 2025-10-02 20:57:35.909892 | controller | Thursday 02 October 2025 20:57:27 +0000 (0:00:01.150) 0:00:04.720 ****** 2025-10-02 20:57:35.909902 | controller | changed: [instance] 2025-10-02 20:57:36.626534 | controller | 2025-10-02 20:57:36.626570 | controller | TASK [repo_setup : Install repo-setup package] ********************************* 2025-10-02 20:57:36.626578 | controller | Thursday 02 October 2025 20:57:35 +0000 (0:00:07.988) 0:00:12.708 ****** 2025-10-02 20:57:36.626588 | controller | changed: [instance] 2025-10-02 20:57:36.648741 | controller | 2025-10-02 20:57:36.648767 | controller | TASK [repo_setup : Set cifmw_repo_setup_dlrn_hash_tag from content provider] *** 2025-10-02 20:57:36.648775 | controller | Thursday 02 October 2025 20:57:36 +0000 (0:00:00.716) 0:00:13.425 ****** 2025-10-02 20:57:36.648784 | controller | skipping: [instance] 2025-10-02 20:57:37.481810 | controller | 2025-10-02 20:57:37.481843 | controller | TASK [repo_setup : Run repo-setup] ********************************************* 2025-10-02 20:57:37.481851 | controller | Thursday 02 October 2025 20:57:36 +0000 (0:00:00.022) 0:00:13.447 ****** 2025-10-02 20:57:37.481861 | controller | changed: [instance] 2025-10-02 20:57:37.518148 | controller | 2025-10-02 20:57:37.518180 | controller | TASK [repo_setup : Get component repo] ***************************************** 2025-10-02 20:57:37.518189 | controller | Thursday 02 October 2025 20:57:37 +0000 (0:00:00.832) 0:00:14.280 ****** 2025-10-02 20:57:37.518200 | controller | skipping: [instance] 2025-10-02 20:57:37.555632 | controller | 2025-10-02 20:57:37.555703 | controller | TASK [repo_setup : Rename component repo] ************************************** 2025-10-02 20:57:37.555713 | controller | Thursday 02 October 2025 20:57:37 +0000 (0:00:00.036) 0:00:14.316 ****** 2025-10-02 20:57:37.555728 | controller | skipping: [instance] 2025-10-02 20:57:37.595137 | controller | 2025-10-02 20:57:37.595188 | controller | TASK [repo_setup : Disable component repo in current-podified dlrn repo] ******* 2025-10-02 20:57:37.595197 | controller | Thursday 02 October 2025 20:57:37 +0000 (0:00:00.036) 0:00:14.353 ****** 2025-10-02 20:57:37.595211 | controller | skipping: [instance] 2025-10-02 20:57:37.595287 | controller | 2025-10-02 20:57:37.595464 | controller | TASK [repo_setup : Run repo-setup-get-hash] ************************************ 2025-10-02 20:57:37.595612 | controller | Thursday 02 October 2025 20:57:37 +0000 (0:00:00.040) 0:00:14.394 ****** 2025-10-02 20:57:38.171528 | controller | changed: [instance] 2025-10-02 20:57:38.624021 | controller | 2025-10-02 20:57:38.624051 | controller | TASK [repo_setup : Dump full hash in delorean.repo.md5 file] ******************* 2025-10-02 20:57:38.624060 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.576) 0:00:14.970 ****** 2025-10-02 20:57:38.624070 | controller | changed: [instance] 2025-10-02 20:57:38.652944 | controller | 2025-10-02 20:57:38.652962 | controller | TASK [repo_setup : Dump current-podified hash] ********************************* 2025-10-02 20:57:38.652969 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.452) 0:00:15.422 ****** 2025-10-02 20:57:38.652978 | controller | skipping: [instance] 2025-10-02 20:57:38.681533 | controller | 2025-10-02 20:57:38.681567 | controller | TASK [repo_setup : Slurp current podified hash] ******************************** 2025-10-02 20:57:38.681575 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.029) 0:00:15.452 ****** 2025-10-02 20:57:38.681589 | controller | skipping: [instance] 2025-10-02 20:57:38.710219 | controller | 2025-10-02 20:57:38.710240 | controller | TASK [repo_setup : Update the value of full_hash] ****************************** 2025-10-02 20:57:38.710248 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.028) 0:00:15.480 ****** 2025-10-02 20:57:38.710258 | controller | skipping: [instance] 2025-10-02 20:57:38.749214 | controller | 2025-10-02 20:57:38.749235 | controller | TASK [repo_setup : Export hashes facts for further use] ************************ 2025-10-02 20:57:38.749243 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.028) 0:00:15.509 ****** 2025-10-02 20:57:38.749252 | controller | ok: [instance] 2025-10-02 20:57:38.777409 | controller | 2025-10-02 20:57:38.777431 | controller | TASK [repo_setup : Create download directory] ********************************** 2025-10-02 20:57:38.777454 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.038) 0:00:15.548 ****** 2025-10-02 20:57:38.777467 | controller | skipping: [instance] 2025-10-02 20:57:38.804263 | controller | 2025-10-02 20:57:38.804295 | controller | TASK [repo_setup : Print the URL to request] *********************************** 2025-10-02 20:57:38.804303 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.028) 0:00:15.576 ****** 2025-10-02 20:57:38.804320 | controller | skipping: [instance] 2025-10-02 20:57:38.831929 | controller | 2025-10-02 20:57:38.831949 | controller | TASK [Download the RPM] ******************************************************** 2025-10-02 20:57:38.831956 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.027) 0:00:15.603 ****** 2025-10-02 20:57:38.831965 | controller | skipping: [instance] 2025-10-02 20:57:38.859954 | controller | 2025-10-02 20:57:38.859978 | controller | TASK [repo_setup : Install RHOS Release tool] ********************************** 2025-10-02 20:57:38.859985 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.027) 0:00:15.631 ****** 2025-10-02 20:57:38.859995 | controller | skipping: [instance] 2025-10-02 20:57:38.886995 | controller | 2025-10-02 20:57:38.887017 | controller | TASK [repo_setup : Get rhos-release tool version] ****************************** 2025-10-02 20:57:38.887025 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.027) 0:00:15.658 ****** 2025-10-02 20:57:38.887034 | controller | skipping: [instance] 2025-10-02 20:57:38.916967 | controller | 2025-10-02 20:57:38.916992 | controller | TASK [repo_setup : Print rhos-release tool version] **************************** 2025-10-02 20:57:38.916999 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.027) 0:00:15.686 ****** 2025-10-02 20:57:38.917008 | controller | skipping: [instance] 2025-10-02 20:57:38.943621 | controller | 2025-10-02 20:57:38.943643 | controller | TASK [repo_setup : Generate repos using rhos-release {{ cifmw_repo_setup_rhos_release_args }}] *** 2025-10-02 20:57:38.943651 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.029) 0:00:15.715 ****** 2025-10-02 20:57:38.943660 | controller | skipping: [instance] 2025-10-02 20:57:39.143363 | controller | 2025-10-02 20:57:39.143393 | controller | TASK [repo_setup : Check for /etc/ci/mirror_info.sh] *************************** 2025-10-02 20:57:39.143401 | controller | Thursday 02 October 2025 20:57:38 +0000 (0:00:00.026) 0:00:15.742 ****** 2025-10-02 20:57:39.143411 | controller | ok: [instance] 2025-10-02 20:57:39.353831 | controller | 2025-10-02 20:57:39.353862 | controller | TASK [repo_setup : Use RDO proxy mirrors] ************************************** 2025-10-02 20:57:39.353870 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.199) 0:00:15.942 ****** 2025-10-02 20:57:39.353885 | controller | changed: [instance] 2025-10-02 20:57:39.586244 | controller | 2025-10-02 20:57:39.586289 | controller | TASK [repo_setup : Use RDO CentOS mirrors (remove CentOS 10 conditional when Nodepool mirrors exist)] *** 2025-10-02 20:57:39.586299 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.210) 0:00:16.152 ****** 2025-10-02 20:57:39.586309 | controller | changed: [instance] 2025-10-02 20:57:39.606106 | controller | 2025-10-02 20:57:39.606130 | controller | TASK [repo_setup : Check for gating.repo file on content provider] ************* 2025-10-02 20:57:39.606138 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.232) 0:00:16.385 ****** 2025-10-02 20:57:39.606148 | controller | skipping: [instance] 2025-10-02 20:57:39.626125 | controller | 2025-10-02 20:57:39.626147 | controller | TASK [repo_setup : Populate gating repo from content provider ip] ************** 2025-10-02 20:57:39.626155 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.020) 0:00:16.405 ****** 2025-10-02 20:57:39.626164 | controller | skipping: [instance] 2025-10-02 20:57:39.645803 | controller | 2025-10-02 20:57:39.645828 | controller | TASK [repo_setup : Check for DLRN repo at the destination] ********************* 2025-10-02 20:57:39.645836 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.020) 0:00:16.425 ****** 2025-10-02 20:57:39.645845 | controller | skipping: [instance] 2025-10-02 20:57:39.665405 | controller | 2025-10-02 20:57:39.665427 | controller | TASK [repo_setup : Lower the priority of DLRN repos to allow installation from gating repo] *** 2025-10-02 20:57:39.665450 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.019) 0:00:16.444 ****** 2025-10-02 20:57:39.665463 | controller | skipping: [instance] 2025-10-02 20:57:39.684557 | controller | 2025-10-02 20:57:39.684595 | controller | TASK [repo_setup : Check for DLRN component repo] ****************************** 2025-10-02 20:57:39.684610 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.019) 0:00:16.464 ****** 2025-10-02 20:57:39.684623 | controller | skipping: [instance] 2025-10-02 20:57:39.684652 | controller | 2025-10-02 20:57:39.684663 | controller | TASK [repo_setup : Lower the priority of componennt repos to allow installation from gating repo] *** 2025-10-02 20:57:39.684764 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.019) 0:00:16.483 ****** 2025-10-02 20:57:39.706424 | controller | skipping: [instance] 2025-10-02 20:57:39.721406 | controller | 2025-10-02 20:57:39.721431 | controller | TASK [repo_setup : Find existing repos from /etc/yum.repos.d directory] ******** 2025-10-02 20:57:39.721456 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.021) 0:00:16.505 ****** 2025-10-02 20:57:39.721466 | controller | skipping: [instance] 2025-10-02 20:57:39.748307 | controller | 2025-10-02 20:57:39.748331 | controller | TASK [repo_setup : Remove existing repos from /etc/yum.repos.d directory] ****** 2025-10-02 20:57:39.748339 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.015) 0:00:16.520 ****** 2025-10-02 20:57:39.748348 | controller | skipping: [instance] 2025-10-02 20:57:39.763122 | controller | 2025-10-02 20:57:39.763144 | controller | TASK [repo_setup : Cleanup existing metadata] ********************************** 2025-10-02 20:57:39.763151 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.026) 0:00:16.547 ****** 2025-10-02 20:57:39.763160 | controller | skipping: [instance] 2025-10-02 20:57:39.781943 | controller | 2025-10-02 20:57:39.781966 | controller | TASK [repo_setup : Copy generated repos to /etc/yum.repos.d directory] ********* 2025-10-02 20:57:39.781975 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.014) 0:00:16.562 ****** 2025-10-02 20:57:39.781986 | controller | skipping: [instance] 2025-10-02 20:57:39.809542 | controller | 2025-10-02 20:57:39.809576 | controller | TASK [test_deps : Look for redhat-release rpm] ********************************* 2025-10-02 20:57:39.809585 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.018) 0:00:16.581 ****** 2025-10-02 20:57:39.809597 | controller | skipping: [instance] 2025-10-02 20:57:39.837079 | controller | 2025-10-02 20:57:39.837108 | controller | TASK [test_deps : Remove redhat-release] *************************************** 2025-10-02 20:57:39.837116 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.027) 0:00:16.608 ****** 2025-10-02 20:57:39.837126 | controller | skipping: [instance] 2025-10-02 20:57:39.864507 | controller | 2025-10-02 20:57:39.864542 | controller | TASK [test_deps : Install centos-stream-release] ******************************* 2025-10-02 20:57:39.864552 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.027) 0:00:16.636 ****** 2025-10-02 20:57:39.864565 | controller | skipping: [instance] 2025-10-02 20:57:39.864658 | controller | 2025-10-02 20:57:39.864687 | controller | TASK [test_deps : Install additional packages] ********************************* 2025-10-02 20:57:39.892551 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.027) 0:00:16.663 ****** 2025-10-02 20:57:39.892579 | controller | skipping: [instance] 2025-10-02 20:57:39.892678 | controller | 2025-10-02 20:57:39.892704 | controller | TASK [test_deps : Install selinux python libs] ********************************* 2025-10-02 20:57:39.892716 | controller | Thursday 02 October 2025 20:57:39 +0000 (0:00:00.028) 0:00:16.691 ****** 2025-10-02 20:58:22.375929 | controller | ok: [instance] 2025-10-02 20:58:23.504610 | controller | 2025-10-02 20:58:23.504641 | controller | TASK [test_deps : Install python yaml libs] ************************************ 2025-10-02 20:58:23.504649 | controller | Thursday 02 October 2025 20:58:22 +0000 (0:00:42.483) 0:00:59.174 ****** 2025-10-02 20:58:23.504659 | controller | ok: [instance] 2025-10-02 20:58:23.538383 | controller | 2025-10-02 20:58:23.538420 | controller | TASK [test_deps : Install extra packages] ************************************** 2025-10-02 20:58:23.538429 | controller | Thursday 02 October 2025 20:58:23 +0000 (0:00:01.128) 0:01:00.303 ****** 2025-10-02 20:58:23.538461 | controller | skipping: [instance] 2025-10-02 20:58:25.867570 | controller | 2025-10-02 20:58:25.867604 | controller | TASK [Get the zuul/zuul-jobs repo] ********************************************* 2025-10-02 20:58:25.867613 | controller | Thursday 02 October 2025 20:58:23 +0000 (0:00:00.033) 0:01:00.337 ****** 2025-10-02 20:58:25.867625 | controller | changed: [instance] 2025-10-02 20:58:25.867653 | controller | 2025-10-02 20:58:25.867660 | controller | PLAY RECAP ********************************************************************* 2025-10-02 20:58:25.867667 | controller | instance : ok=20 changed=10 unreachable=0 failed=0 skipped=30 rescued=0 ignored=0 2025-10-02 20:58:25.867682 | controller | 2025-10-02 20:58:25.867689 | controller | Thursday 02 October 2025 20:58:25 +0000 (0:00:02.328) 0:01:02.666 ****** 2025-10-02 20:58:25.867696 | controller | =============================================================================== 2025-10-02 20:58:25.867705 | controller | test_deps : Install selinux python libs -------------------------------- 42.48s 2025-10-02 20:58:25.869463 | controller | repo_setup : Initialize python venv and install requirements ------------ 7.99s 2025-10-02 20:58:25.925986 | controller | Get the zuul/zuul-jobs repo --------------------------------------------- 2.33s 2025-10-02 20:58:25.926017 | controller | repo_setup : Get repo-setup repository ---------------------------------- 1.15s 2025-10-02 20:58:25.926024 | controller | test_deps : Install python yaml libs ------------------------------------ 1.13s 2025-10-02 20:58:25.926030 | controller | repo_setup : Run repo-setup --------------------------------------------- 0.83s 2025-10-02 20:58:25.926035 | controller | Gathering Facts --------------------------------------------------------- 0.83s 2025-10-02 20:58:25.926041 | controller | repo_setup : Make sure git-core package is installed -------------------- 0.78s 2025-10-02 20:58:25.926046 | controller | repo_setup : Install repo-setup package --------------------------------- 0.72s 2025-10-02 20:58:25.926051 | controller | test_deps : Disable ubi 9 repos ----------------------------------------- 0.70s 2025-10-02 20:58:25.926056 | controller | repo_setup : Run repo-setup-get-hash ------------------------------------ 0.58s 2025-10-02 20:58:25.926061 | controller | repo_setup : Ensure directories are present ----------------------------- 0.54s 2025-10-02 20:58:25.926067 | controller | repo_setup : Dump full hash in delorean.repo.md5 file ------------------- 0.45s 2025-10-02 20:58:25.926072 | controller | test_deps : Disable ubi host subscription-manager integration ----------- 0.31s 2025-10-02 20:58:25.926077 | controller | test_deps : Detect mirrors file ----------------------------------------- 0.28s 2025-10-02 20:58:25.926082 | controller | repo_setup : Use RDO CentOS mirrors (remove CentOS 10 conditional when Nodepool mirrors exist) --- 0.23s 2025-10-02 20:58:25.926088 | controller | repo_setup : Use RDO proxy mirrors -------------------------------------- 0.21s 2025-10-02 20:58:25.926093 | controller | repo_setup : Check for /etc/ci/mirror_info.sh --------------------------- 0.20s 2025-10-02 20:58:25.926098 | controller | Deploy repo-setup ------------------------------------------------------- 0.06s 2025-10-02 20:58:25.926104 | controller | test_deps : Gather variables for each operating system ------------------ 0.04s 2025-10-02 20:58:25.926114 | controller | INFO Running check_criteria > converge 2025-10-02 20:58:26.337997 | controller | 2025-10-02 20:58:27.117290 | controller | PLAY [Converge] **************************************************************** 2025-10-02 20:58:27.117321 | controller | 2025-10-02 20:58:27.117329 | controller | TASK [Gathering Facts] ********************************************************* 2025-10-02 20:58:27.117335 | controller | Thursday 02 October 2025 20:58:26 +0000 (0:00:00.034) 0:00:00.034 ****** 2025-10-02 20:58:27.117344 | controller | ok: [instance] 2025-10-02 20:58:27.143041 | controller | 2025-10-02 20:58:27.143069 | controller | TASK [Check check_promotion_criteria playbook] ********************************* 2025-10-02 20:58:27.143078 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.779) 0:00:00.814 ****** 2025-10-02 20:58:27.143090 | controller | 2025-10-02 20:58:27.171482 | controller | TASK [dlrn_promote : Empty dlrnapi output (no jobs reported)] ****************** 2025-10-02 20:58:27.171515 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.025) 0:00:00.840 ****** 2025-10-02 20:58:27.171527 | controller | skipping: [instance] 2025-10-02 20:58:27.473019 | controller | 2025-10-02 20:58:27.473050 | controller | TASK [dlrn_promote : Check for criteria file before copying] ******************* 2025-10-02 20:58:27.473058 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.028) 0:00:00.868 ****** 2025-10-02 20:58:27.473068 | controller | ok: [instance] 2025-10-02 20:58:27.503287 | controller | 2025-10-02 20:58:27.503313 | controller | TASK [dlrn_promote : Abort the role on missing criteria file] ****************** 2025-10-02 20:58:27.503320 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.301) 0:00:01.170 ****** 2025-10-02 20:58:27.503330 | controller | skipping: [instance] 2025-10-02 20:58:27.790871 | controller | 2025-10-02 20:58:27.790902 | controller | TASK [dlrn_promote : Slurp criteria file] ************************************** 2025-10-02 20:58:27.790910 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.030) 0:00:01.200 ****** 2025-10-02 20:58:27.790920 | controller | ok: [instance] 2025-10-02 20:58:27.825355 | controller | 2025-10-02 20:58:27.825386 | controller | TASK [dlrn_promote : Set fact for criteria] ************************************ 2025-10-02 20:58:27.825399 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.287) 0:00:01.487 ****** 2025-10-02 20:58:27.825409 | controller | ok: [instance] 2025-10-02 20:58:27.885557 | controller | 2025-10-02 20:58:27.885591 | controller | TASK [dlrn_promote : Query to match promotion criteria] ************************ 2025-10-02 20:58:27.885601 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.034) 0:00:01.522 ****** 2025-10-02 20:58:27.885614 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/query_criteria.yml for instance => (item=periodic-podified-edpm-baremetal-antelope-ocp-crc) 2025-10-02 20:58:27.885643 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/query_criteria.yml for instance => (item=periodic-podified-edpm-deployment-antelope-ocp-crc-1cs9) 2025-10-02 20:58:27.885654 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/query_criteria.yml for instance => (item=periodic-data-plane-adoption-github-rdo-centos-9-crc-single-node-antelope) 2025-10-02 20:58:27.886016 | controller | 2025-10-02 20:58:27.916527 | controller | TASK [dlrn_promote : Debug criteria job] *************************************** 2025-10-02 20:58:27.916559 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.060) 0:00:01.582 ****** 2025-10-02 20:58:27.916573 | controller | ok: [instance] => 2025-10-02 20:58:27.916600 | controller | msg: 'DEBUG: criteria job --->periodic-podified-edpm-baremetal-antelope-ocp-crc<---' 2025-10-02 20:58:27.916609 | controller | 2025-10-02 20:58:27.916616 | controller | TASK [dlrn_promote : Debug reported jobs] ************************************** 2025-10-02 20:58:27.916624 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.030) 0:00:01.613 ****** 2025-10-02 20:58:27.947075 | controller | ok: [instance] => 2025-10-02 20:58:27.977218 | controller | msg: 'DEBUG: dlrnapi reported jobs --->[''periodic-podified-edpm-baremetal-antelope-ocp-crc'', ''periodic-podified-edpm-deployment-antelope-ocp-crc-1cs9'', ''periodic-data-plane-adoption-github-rdo-centos-9-crc-single-node-antelope'']<---' 2025-10-02 20:58:27.977245 | controller | 2025-10-02 20:58:27.977252 | controller | TASK [dlrn_promote : Criteria failed?] ***************************************** 2025-10-02 20:58:27.977259 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.030) 0:00:01.644 ****** 2025-10-02 20:58:27.977268 | controller | skipping: [instance] 2025-10-02 20:58:28.007941 | controller | 2025-10-02 20:58:28.007964 | controller | TASK [dlrn_promote : Criteria match?] ****************************************** 2025-10-02 20:58:28.007971 | controller | Thursday 02 October 2025 20:58:27 +0000 (0:00:00.030) 0:00:01.674 ****** 2025-10-02 20:58:28.007980 | controller | ok: [instance] => 2025-10-02 20:58:28.038199 | controller | msg: SUCCESS! :) Promotion criteria match! 2025-10-02 20:58:28.038225 | controller | 2025-10-02 20:58:28.038233 | controller | TASK [dlrn_promote : Debug criteria job] *************************************** 2025-10-02 20:58:28.038239 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.030) 0:00:01.704 ****** 2025-10-02 20:58:28.038249 | controller | ok: [instance] => 2025-10-02 20:58:28.068112 | controller | msg: 'DEBUG: criteria job --->periodic-podified-edpm-deployment-antelope-ocp-crc-1cs9<---' 2025-10-02 20:58:28.068152 | controller | 2025-10-02 20:58:28.068162 | controller | TASK [dlrn_promote : Debug reported jobs] ************************************** 2025-10-02 20:58:28.068170 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.030) 0:00:01.735 ****** 2025-10-02 20:58:28.068181 | controller | ok: [instance] => 2025-10-02 20:58:28.068389 | controller | msg: 'DEBUG: dlrnapi reported jobs --->[''periodic-podified-edpm-baremetal-antelope-ocp-crc'', ''periodic-podified-edpm-deployment-antelope-ocp-crc-1cs9'', ''periodic-data-plane-adoption-github-rdo-centos-9-crc-single-node-antelope'']<---' 2025-10-02 20:58:28.068609 | controller | 2025-10-02 20:58:28.068794 | controller | TASK [dlrn_promote : Criteria failed?] ***************************************** 2025-10-02 20:58:28.068973 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.030) 0:00:01.765 ****** 2025-10-02 20:58:28.096153 | controller | skipping: [instance] 2025-10-02 20:58:28.096346 | controller | 2025-10-02 20:58:28.096551 | controller | TASK [dlrn_promote : Criteria match?] ****************************************** 2025-10-02 20:58:28.096734 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.028) 0:00:01.793 ****** 2025-10-02 20:58:28.127950 | controller | ok: [instance] => 2025-10-02 20:58:28.128184 | controller | msg: SUCCESS! :) Promotion criteria match! 2025-10-02 20:58:28.128326 | controller | 2025-10-02 20:58:28.128495 | controller | TASK [dlrn_promote : Debug criteria job] *************************************** 2025-10-02 20:58:28.128653 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.031) 0:00:01.825 ****** 2025-10-02 20:58:28.159037 | controller | ok: [instance] => 2025-10-02 20:58:28.159240 | controller | msg: 'DEBUG: criteria job --->periodic-data-plane-adoption-github-rdo-centos-9-crc-single-node-antelope<---' 2025-10-02 20:58:28.159382 | controller | 2025-10-02 20:58:28.159554 | controller | TASK [dlrn_promote : Debug reported jobs] ************************************** 2025-10-02 20:58:28.159711 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.031) 0:00:01.856 ****** 2025-10-02 20:58:28.189959 | controller | ok: [instance] => 2025-10-02 20:58:28.190200 | controller | msg: 'DEBUG: dlrnapi reported jobs --->[''periodic-podified-edpm-baremetal-antelope-ocp-crc'', ''periodic-podified-edpm-deployment-antelope-ocp-crc-1cs9'', ''periodic-data-plane-adoption-github-rdo-centos-9-crc-single-node-antelope'']<---' 2025-10-02 20:58:28.190356 | controller | 2025-10-02 20:58:28.190530 | controller | TASK [dlrn_promote : Criteria failed?] ***************************************** 2025-10-02 20:58:28.190678 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.030) 0:00:01.887 ****** 2025-10-02 20:58:28.221030 | controller | skipping: [instance] 2025-10-02 20:58:28.221271 | controller | 2025-10-02 20:58:28.221466 | controller | TASK [dlrn_promote : Criteria match?] ****************************************** 2025-10-02 20:58:28.221633 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.030) 0:00:01.918 ****** 2025-10-02 20:58:28.268061 | controller | ok: [instance] => 2025-10-02 20:58:28.268266 | controller | msg: SUCCESS! :) Promotion criteria match! 2025-10-02 20:58:28.268410 | controller | 2025-10-02 20:58:28.268582 | controller | PLAY RECAP ********************************************************************* 2025-10-02 20:58:28.268751 | controller | instance : ok=16 changed=0 unreachable=0 failed=0 skipped=5 rescued=0 ignored=0 2025-10-02 20:58:28.268889 | controller | 2025-10-02 20:58:28.269032 | controller | Thursday 02 October 2025 20:58:28 +0000 (0:00:00.047) 0:00:01.965 ****** 2025-10-02 20:58:28.269186 | controller | =============================================================================== 2025-10-02 20:58:28.269329 | controller | Gathering Facts --------------------------------------------------------- 0.78s 2025-10-02 20:58:28.269496 | controller | dlrn_promote : Check for criteria file before copying ------------------- 0.30s 2025-10-02 20:58:28.269641 | controller | dlrn_promote : Slurp criteria file -------------------------------------- 0.29s 2025-10-02 20:58:28.269778 | controller | dlrn_promote : Query to match promotion criteria ------------------------ 0.06s 2025-10-02 20:58:28.269914 | controller | dlrn_promote : Criteria match? ------------------------------------------ 0.05s 2025-10-02 20:58:28.270044 | controller | dlrn_promote : Set fact for criteria ------------------------------------ 0.03s 2025-10-02 20:58:28.270195 | controller | dlrn_promote : Criteria match? ------------------------------------------ 0.03s 2025-10-02 20:58:28.270339 | controller | dlrn_promote : Debug criteria job --------------------------------------- 0.03s 2025-10-02 20:58:28.270499 | controller | dlrn_promote : Debug criteria job --------------------------------------- 0.03s 2025-10-02 20:58:28.270638 | controller | dlrn_promote : Criteria failed? ----------------------------------------- 0.03s 2025-10-02 20:58:28.270770 | controller | dlrn_promote : Debug reported jobs -------------------------------------- 0.03s 2025-10-02 20:58:28.271131 | controller | dlrn_promote : Debug reported jobs -------------------------------------- 0.03s 2025-10-02 20:58:28.271298 | controller | dlrn_promote : Criteria match? ------------------------------------------ 0.03s 2025-10-02 20:58:28.271434 | controller | dlrn_promote : Debug reported jobs -------------------------------------- 0.03s 2025-10-02 20:58:28.271604 | controller | dlrn_promote : Criteria failed? ----------------------------------------- 0.03s 2025-10-02 20:58:28.271741 | controller | dlrn_promote : Debug criteria job --------------------------------------- 0.03s 2025-10-02 20:58:28.271876 | controller | dlrn_promote : Abort the role on missing criteria file ------------------ 0.03s 2025-10-02 20:58:28.272008 | controller | dlrn_promote : Empty dlrnapi output (no jobs reported) ------------------ 0.03s 2025-10-02 20:58:28.272154 | controller | dlrn_promote : Criteria failed? ----------------------------------------- 0.03s 2025-10-02 20:58:28.272294 | controller | Check check_promotion_criteria playbook --------------------------------- 0.03s 2025-10-02 20:58:28.323252 | controller | INFO Running check_criteria > cleanup 2025-10-02 20:58:28.323779 | controller | WARNING Skipping, cleanup playbook not configured. 2025-10-02 20:58:28.324238 | controller | INFO Performing prerun with role_name_check=0... 2025-10-02 20:58:45.316243 | controller | WARNING Another version of '@NAMESPACE@.@NAME@' 3.1.4 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 3.1.4 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.316877 | controller | WARNING Another version of 'ansible.netcommon' 7.1.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 7.1.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.317423 | controller | WARNING Another version of 'ansible.posix' 1.6.2 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.6.2 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.317949 | controller | WARNING Another version of 'ansible.utils' 5.1.2 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 5.1.2 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.318511 | controller | WARNING Another version of 'cifmw.general' 1.0.0+41f2edaa was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.0.0+41f2edaa (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.319009 | controller | WARNING Another version of 'cisco.ios' 9.0.3 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 9.0.3 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.319520 | controller | WARNING Another version of 'community.crypto' 2.22.3 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 2.22.3 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.320008 | controller | WARNING Another version of 'community.general' 10.0.1 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 10.0.1 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.320526 | controller | WARNING Another version of 'community.libvirt' 1.3.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.3.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.321011 | controller | WARNING Another version of 'community.okd' 4.0.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 4.0.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.321518 | controller | WARNING Another version of 'containers.podman' 1.16.2 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.16.2 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.322002 | controller | WARNING Another version of 'junipernetworks.junos' 9.1.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 9.1.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.322501 | controller | WARNING Another version of 'kubernetes.core' 5.0.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 5.0.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.322989 | controller | WARNING Another version of 'mellanox.onyx' 1.0.0 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 1.0.0 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.323494 | controller | WARNING Another version of 'openstack.config_template' 2.1.1 was found installed in /home/zuul/.cache/ansible-compat/087b64/collections/ansible_collections, only the first one will be used, 2.1.1 (/home/zuul/.ansible/collections/ansible_collections). 2025-10-02 20:58:45.332143 | controller | INFO Running default > prepare 2025-10-02 20:58:45.779008 | controller | 2025-10-02 20:58:46.579449 | controller | PLAY [Prepare] ***************************************************************** 2025-10-02 20:58:46.579480 | controller | 2025-10-02 20:58:46.579488 | controller | TASK [Gathering Facts] ********************************************************* 2025-10-02 20:58:46.579494 | controller | Thursday 02 October 2025 20:58:45 +0000 (0:00:00.016) 0:00:00.016 ****** 2025-10-02 20:58:46.579504 | controller | ok: [instance] 2025-10-02 20:58:46.595567 | controller | 2025-10-02 20:58:46.595592 | controller | TASK [test_deps : Gather facts if they don't exist] **************************** 2025-10-02 20:58:46.595600 | controller | Thursday 02 October 2025 20:58:46 +0000 (0:00:00.801) 0:00:00.817 ****** 2025-10-02 20:58:46.595611 | controller | skipping: [instance] 2025-10-02 20:58:46.595678 | controller | 2025-10-02 20:58:46.595695 | controller | TASK [test_deps : Gather variables for each operating system] ****************** 2025-10-02 20:58:46.595705 | controller | Thursday 02 October 2025 20:58:46 +0000 (0:00:00.016) 0:00:00.833 ****** 2025-10-02 20:58:46.634516 | controller | ok: [instance] => (item=/home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/test_deps/vars/centos-9.yml) 2025-10-02 20:58:46.634743 | controller | 2025-10-02 20:58:46.634765 | controller | TASK [test_deps : Detect mirrors file] ***************************************** 2025-10-02 20:58:46.915175 | controller | Thursday 02 October 2025 20:58:46 +0000 (0:00:00.038) 0:00:00.872 ****** 2025-10-02 20:58:46.915215 | controller | ok: [instance] 2025-10-02 20:58:47.225226 | controller | 2025-10-02 20:58:47.225256 | controller | TASK [test_deps : Disable ubi host subscription-manager integration] *********** 2025-10-02 20:58:47.225269 | controller | Thursday 02 October 2025 20:58:46 +0000 (0:00:00.280) 0:00:01.153 ****** 2025-10-02 20:58:47.225280 | controller | ok: [instance] 2025-10-02 20:58:47.924426 | controller | 2025-10-02 20:58:47.924474 | controller | TASK [test_deps : Disable ubi 9 repos] ***************************************** 2025-10-02 20:58:47.924483 | controller | Thursday 02 October 2025 20:58:47 +0000 (0:00:00.309) 0:00:01.463 ****** 2025-10-02 20:58:47.924493 | controller | ok: [instance] => (item=ubi-9-appstream) 2025-10-02 20:58:47.981932 | controller | ok: [instance] => (item=ubi-9-baseos) 2025-10-02 20:58:47.981963 | controller | ok: [instance] => (item=ubi-9-codeready-builder) 2025-10-02 20:58:47.981971 | controller | 2025-10-02 20:58:47.981977 | controller | TASK [Deploy repo-setup] ******************************************************* 2025-10-02 20:58:47.981983 | controller | Thursday 02 October 2025 20:58:47 +0000 (0:00:00.698) 0:00:02.162 ****** 2025-10-02 20:58:47.981993 | controller | 2025-10-02 20:58:48.512728 | controller | TASK [repo_setup : Ensure directories are present] ***************************** 2025-10-02 20:58:48.512758 | controller | Thursday 02 October 2025 20:58:47 +0000 (0:00:00.057) 0:00:02.219 ****** 2025-10-02 20:58:48.512769 | controller | ok: [instance] => (item=tmp) 2025-10-02 20:58:49.762359 | controller | ok: [instance] => (item=artifacts/repositories) 2025-10-02 20:58:49.762396 | controller | ok: [instance] => (item=venv/repo_setup) 2025-10-02 20:58:49.762404 | controller | 2025-10-02 20:58:49.762410 | controller | TASK [repo_setup : Make sure git-core package is installed] ******************** 2025-10-02 20:58:49.762416 | controller | Thursday 02 October 2025 20:58:48 +0000 (0:00:00.530) 0:00:02.750 ****** 2025-10-02 20:58:49.762425 | controller | ok: [instance] 2025-10-02 20:58:50.384934 | controller | 2025-10-02 20:58:50.384964 | controller | TASK [repo_setup : Get repo-setup repository] ********************************** 2025-10-02 20:58:50.384972 | controller | Thursday 02 October 2025 20:58:49 +0000 (0:00:01.250) 0:00:04.000 ****** 2025-10-02 20:58:50.384982 | controller | ok: [instance] 2025-10-02 20:58:51.660532 | controller | 2025-10-02 20:58:51.660563 | controller | TASK [repo_setup : Initialize python venv and install requirements] ************ 2025-10-02 20:58:51.660572 | controller | Thursday 02 October 2025 20:58:50 +0000 (0:00:00.622) 0:00:04.622 ****** 2025-10-02 20:58:51.660582 | controller | ok: [instance] 2025-10-02 20:58:51.660606 | controller | 2025-10-02 20:58:51.660797 | controller | TASK [repo_setup : Install repo-setup package] ********************************* 2025-10-02 20:58:51.945789 | controller | Thursday 02 October 2025 20:58:51 +0000 (0:00:01.275) 0:00:05.898 ****** 2025-10-02 20:58:51.945824 | controller | ok: [instance] 2025-10-02 20:58:51.967063 | controller | 2025-10-02 20:58:51.967084 | controller | TASK [repo_setup : Set cifmw_repo_setup_dlrn_hash_tag from content provider] *** 2025-10-02 20:58:51.967107 | controller | Thursday 02 October 2025 20:58:51 +0000 (0:00:00.285) 0:00:06.183 ****** 2025-10-02 20:58:51.967117 | controller | skipping: [instance] 2025-10-02 20:58:52.876428 | controller | 2025-10-02 20:58:52.876475 | controller | TASK [repo_setup : Run repo-setup] ********************************************* 2025-10-02 20:58:52.876483 | controller | Thursday 02 October 2025 20:58:51 +0000 (0:00:00.021) 0:00:06.205 ****** 2025-10-02 20:58:52.876493 | controller | changed: [instance] 2025-10-02 20:58:52.914274 | controller | 2025-10-02 20:58:52.914299 | controller | TASK [repo_setup : Get component repo] ***************************************** 2025-10-02 20:58:52.914307 | controller | Thursday 02 October 2025 20:58:52 +0000 (0:00:00.909) 0:00:07.114 ****** 2025-10-02 20:58:52.914316 | controller | skipping: [instance] 2025-10-02 20:58:52.952160 | controller | 2025-10-02 20:58:52.952189 | controller | TASK [repo_setup : Rename component repo] ************************************** 2025-10-02 20:58:52.952196 | controller | Thursday 02 October 2025 20:58:52 +0000 (0:00:00.037) 0:00:07.152 ****** 2025-10-02 20:58:52.952207 | controller | skipping: [instance] 2025-10-02 20:58:52.991612 | controller | 2025-10-02 20:58:52.991635 | controller | TASK [repo_setup : Disable component repo in current-podified dlrn repo] ******* 2025-10-02 20:58:52.991642 | controller | Thursday 02 October 2025 20:58:52 +0000 (0:00:00.037) 0:00:07.189 ****** 2025-10-02 20:58:52.991652 | controller | skipping: [instance] 2025-10-02 20:58:53.551977 | controller | 2025-10-02 20:58:53.552009 | controller | TASK [repo_setup : Run repo-setup-get-hash] ************************************ 2025-10-02 20:58:53.552017 | controller | Thursday 02 October 2025 20:58:52 +0000 (0:00:00.039) 0:00:07.229 ****** 2025-10-02 20:58:53.552027 | controller | changed: [instance] 2025-10-02 20:58:53.908848 | controller | 2025-10-02 20:58:53.908879 | controller | TASK [repo_setup : Dump full hash in delorean.repo.md5 file] ******************* 2025-10-02 20:58:53.908888 | controller | Thursday 02 October 2025 20:58:53 +0000 (0:00:00.560) 0:00:07.789 ****** 2025-10-02 20:58:53.908897 | controller | ok: [instance] 2025-10-02 20:58:53.937978 | controller | 2025-10-02 20:58:53.938009 | controller | TASK [repo_setup : Dump current-podified hash] ********************************* 2025-10-02 20:58:53.938017 | controller | Thursday 02 October 2025 20:58:53 +0000 (0:00:00.357) 0:00:08.146 ****** 2025-10-02 20:58:53.938031 | controller | skipping: [instance] 2025-10-02 20:58:53.968363 | controller | 2025-10-02 20:58:53.968395 | controller | TASK [repo_setup : Slurp current podified hash] ******************************** 2025-10-02 20:58:53.968403 | controller | Thursday 02 October 2025 20:58:53 +0000 (0:00:00.029) 0:00:08.175 ****** 2025-10-02 20:58:53.968413 | controller | skipping: [instance] 2025-10-02 20:58:53.999302 | controller | 2025-10-02 20:58:53.999336 | controller | TASK [repo_setup : Update the value of full_hash] ****************************** 2025-10-02 20:58:53.999353 | controller | Thursday 02 October 2025 20:58:53 +0000 (0:00:00.030) 0:00:08.206 ****** 2025-10-02 20:58:53.999365 | controller | skipping: [instance] 2025-10-02 20:58:54.039026 | controller | 2025-10-02 20:58:54.039060 | controller | TASK [repo_setup : Export hashes facts for further use] ************************ 2025-10-02 20:58:54.039068 | controller | Thursday 02 October 2025 20:58:53 +0000 (0:00:00.030) 0:00:08.237 ****** 2025-10-02 20:58:54.039078 | controller | ok: [instance] 2025-10-02 20:58:54.067253 | controller | 2025-10-02 20:58:54.067281 | controller | TASK [repo_setup : Create download directory] ********************************** 2025-10-02 20:58:54.067290 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.039) 0:00:08.276 ****** 2025-10-02 20:58:54.067300 | controller | skipping: [instance] 2025-10-02 20:58:54.093906 | controller | 2025-10-02 20:58:54.093941 | controller | TASK [repo_setup : Print the URL to request] *********************************** 2025-10-02 20:58:54.093950 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.028) 0:00:08.305 ****** 2025-10-02 20:58:54.093960 | controller | skipping: [instance] 2025-10-02 20:58:54.094172 | controller | 2025-10-02 20:58:54.094341 | controller | TASK [Download the RPM] ******************************************************** 2025-10-02 20:58:54.094527 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.026) 0:00:08.332 ****** 2025-10-02 20:58:54.120723 | controller | skipping: [instance] 2025-10-02 20:58:54.120927 | controller | 2025-10-02 20:58:54.121111 | controller | TASK [repo_setup : Install RHOS Release tool] ********************************** 2025-10-02 20:58:54.121271 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.026) 0:00:08.358 ****** 2025-10-02 20:58:54.147669 | controller | skipping: [instance] 2025-10-02 20:58:54.147856 | controller | 2025-10-02 20:58:54.148014 | controller | TASK [repo_setup : Get rhos-release tool version] ****************************** 2025-10-02 20:58:54.148181 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.026) 0:00:08.385 ****** 2025-10-02 20:58:54.175683 | controller | skipping: [instance] 2025-10-02 20:58:54.175858 | controller | 2025-10-02 20:58:54.176018 | controller | TASK [repo_setup : Print rhos-release tool version] **************************** 2025-10-02 20:58:54.176194 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.028) 0:00:08.413 ****** 2025-10-02 20:58:54.204662 | controller | skipping: [instance] 2025-10-02 20:58:54.204832 | controller | 2025-10-02 20:58:54.205003 | controller | TASK [repo_setup : Generate repos using rhos-release {{ cifmw_repo_setup_rhos_release_args }}] *** 2025-10-02 20:58:54.205168 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.028) 0:00:08.442 ****** 2025-10-02 20:58:54.233389 | controller | skipping: [instance] 2025-10-02 20:58:54.233567 | controller | 2025-10-02 20:58:54.233721 | controller | TASK [repo_setup : Check for /etc/ci/mirror_info.sh] *************************** 2025-10-02 20:58:54.233868 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.028) 0:00:08.471 ****** 2025-10-02 20:58:54.417492 | controller | ok: [instance] 2025-10-02 20:58:54.624357 | controller | 2025-10-02 20:58:54.624388 | controller | TASK [repo_setup : Use RDO proxy mirrors] ************************************** 2025-10-02 20:58:54.624397 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.183) 0:00:08.655 ****** 2025-10-02 20:58:54.624406 | controller | changed: [instance] 2025-10-02 20:58:54.863051 | controller | 2025-10-02 20:58:54.863082 | controller | TASK [repo_setup : Use RDO CentOS mirrors (remove CentOS 10 conditional when Nodepool mirrors exist)] *** 2025-10-02 20:58:54.863103 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.206) 0:00:08.862 ****** 2025-10-02 20:58:54.863114 | controller | changed: [instance] 2025-10-02 20:58:54.884154 | controller | 2025-10-02 20:58:54.884179 | controller | TASK [repo_setup : Check for gating.repo file on content provider] ************* 2025-10-02 20:58:54.884187 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.238) 0:00:09.100 ****** 2025-10-02 20:58:54.884204 | controller | skipping: [instance] 2025-10-02 20:58:54.906008 | controller | 2025-10-02 20:58:54.906033 | controller | TASK [repo_setup : Populate gating repo from content provider ip] ************** 2025-10-02 20:58:54.906041 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.021) 0:00:09.122 ****** 2025-10-02 20:58:54.906050 | controller | skipping: [instance] 2025-10-02 20:58:54.928177 | controller | 2025-10-02 20:58:54.928204 | controller | TASK [repo_setup : Check for DLRN repo at the destination] ********************* 2025-10-02 20:58:54.928212 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.021) 0:00:09.144 ****** 2025-10-02 20:58:54.928221 | controller | skipping: [instance] 2025-10-02 20:58:54.949821 | controller | 2025-10-02 20:58:54.949851 | controller | TASK [repo_setup : Lower the priority of DLRN repos to allow installation from gating repo] *** 2025-10-02 20:58:54.949859 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.022) 0:00:09.166 ****** 2025-10-02 20:58:54.949867 | controller | skipping: [instance] 2025-10-02 20:58:54.971276 | controller | 2025-10-02 20:58:54.971294 | controller | TASK [repo_setup : Check for DLRN component repo] ****************************** 2025-10-02 20:58:54.971305 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.021) 0:00:09.187 ****** 2025-10-02 20:58:54.971314 | controller | skipping: [instance] 2025-10-02 20:58:54.992289 | controller | 2025-10-02 20:58:54.992307 | controller | TASK [repo_setup : Lower the priority of componennt repos to allow installation from gating repo] *** 2025-10-02 20:58:54.992315 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.021) 0:00:09.209 ****** 2025-10-02 20:58:54.992324 | controller | skipping: [instance] 2025-10-02 20:58:55.008393 | controller | 2025-10-02 20:58:55.008413 | controller | TASK [repo_setup : Find existing repos from /etc/yum.repos.d directory] ******** 2025-10-02 20:58:55.008420 | controller | Thursday 02 October 2025 20:58:54 +0000 (0:00:00.021) 0:00:09.230 ****** 2025-10-02 20:58:55.008429 | controller | skipping: [instance] 2025-10-02 20:58:55.038201 | controller | 2025-10-02 20:58:55.038232 | controller | TASK [repo_setup : Remove existing repos from /etc/yum.repos.d directory] ****** 2025-10-02 20:58:55.038240 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.016) 0:00:09.246 ****** 2025-10-02 20:58:55.038250 | controller | skipping: [instance] 2025-10-02 20:58:55.054392 | controller | 2025-10-02 20:58:55.054414 | controller | TASK [repo_setup : Cleanup existing metadata] ********************************** 2025-10-02 20:58:55.054422 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.029) 0:00:09.276 ****** 2025-10-02 20:58:55.054431 | controller | skipping: [instance] 2025-10-02 20:58:55.074936 | controller | 2025-10-02 20:58:55.074968 | controller | TASK [repo_setup : Copy generated repos to /etc/yum.repos.d directory] ********* 2025-10-02 20:58:55.074977 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.016) 0:00:09.292 ****** 2025-10-02 20:58:55.074988 | controller | skipping: [instance] 2025-10-02 20:58:55.105543 | controller | 2025-10-02 20:58:55.105573 | controller | TASK [test_deps : Look for redhat-release rpm] ********************************* 2025-10-02 20:58:55.105583 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.020) 0:00:09.312 ****** 2025-10-02 20:58:55.105594 | controller | skipping: [instance] 2025-10-02 20:58:55.105782 | controller | 2025-10-02 20:58:55.105804 | controller | TASK [test_deps : Remove redhat-release] *************************************** 2025-10-02 20:58:55.135467 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.030) 0:00:09.343 ****** 2025-10-02 20:58:55.135501 | controller | skipping: [instance] 2025-10-02 20:58:55.165026 | controller | 2025-10-02 20:58:55.165062 | controller | TASK [test_deps : Install centos-stream-release] ******************************* 2025-10-02 20:58:55.165072 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.029) 0:00:09.373 ****** 2025-10-02 20:58:55.165083 | controller | skipping: [instance] 2025-10-02 20:58:55.195316 | controller | 2025-10-02 20:58:55.195347 | controller | TASK [test_deps : Install additional packages] ********************************* 2025-10-02 20:58:55.195356 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.029) 0:00:09.402 ****** 2025-10-02 20:58:55.195366 | controller | skipping: [instance] 2025-10-02 20:59:41.833003 | controller | 2025-10-02 20:59:41.833057 | controller | TASK [test_deps : Install selinux python libs] ********************************* 2025-10-02 20:59:41.833066 | controller | Thursday 02 October 2025 20:58:55 +0000 (0:00:00.030) 0:00:09.433 ****** 2025-10-02 20:59:41.833076 | controller | ok: [instance] 2025-10-02 20:59:43.068889 | controller | 2025-10-02 20:59:43.068920 | controller | TASK [test_deps : Install python yaml libs] ************************************ 2025-10-02 20:59:43.068928 | controller | Thursday 02 October 2025 20:59:41 +0000 (0:00:46.637) 0:00:56.070 ****** 2025-10-02 20:59:43.068945 | controller | ok: [instance] 2025-10-02 20:59:43.100991 | controller | 2025-10-02 20:59:43.101019 | controller | TASK [test_deps : Install extra packages] ************************************** 2025-10-02 20:59:43.101027 | controller | Thursday 02 October 2025 20:59:43 +0000 (0:00:01.235) 0:00:57.306 ****** 2025-10-02 20:59:43.101051 | controller | skipping: [instance] 2025-10-02 20:59:44.133562 | controller | 2025-10-02 20:59:44.133601 | controller | TASK [Get the zuul/zuul-jobs repo] ********************************************* 2025-10-02 20:59:44.133611 | controller | Thursday 02 October 2025 20:59:43 +0000 (0:00:00.032) 0:00:57.338 ****** 2025-10-02 20:59:44.133624 | controller | ok: [instance] 2025-10-02 20:59:44.133652 | controller | 2025-10-02 20:59:44.133660 | controller | PLAY RECAP ********************************************************************* 2025-10-02 20:59:44.133667 | controller | instance : ok=20 changed=4 unreachable=0 failed=0 skipped=30 rescued=0 ignored=0 2025-10-02 20:59:44.133673 | controller | 2025-10-02 20:59:44.133680 | controller | Thursday 02 October 2025 20:59:44 +0000 (0:00:01.031) 0:00:58.370 ****** 2025-10-02 20:59:44.133687 | controller | =============================================================================== 2025-10-02 20:59:44.133693 | controller | test_deps : Install selinux python libs -------------------------------- 46.64s 2025-10-02 20:59:44.133708 | controller | repo_setup : Initialize python venv and install requirements ------------ 1.28s 2025-10-02 20:59:44.133715 | controller | repo_setup : Make sure git-core package is installed -------------------- 1.25s 2025-10-02 20:59:44.133721 | controller | test_deps : Install python yaml libs ------------------------------------ 1.24s 2025-10-02 20:59:44.133728 | controller | Get the zuul/zuul-jobs repo --------------------------------------------- 1.03s 2025-10-02 20:59:44.133734 | controller | repo_setup : Run repo-setup --------------------------------------------- 0.91s 2025-10-02 20:59:44.133741 | controller | Gathering Facts --------------------------------------------------------- 0.80s 2025-10-02 20:59:44.133750 | controller | test_deps : Disable ubi 9 repos ----------------------------------------- 0.70s 2025-10-02 20:59:44.133777 | controller | repo_setup : Get repo-setup repository ---------------------------------- 0.62s 2025-10-02 20:59:44.134877 | controller | repo_setup : Run repo-setup-get-hash ------------------------------------ 0.56s 2025-10-02 20:59:44.214952 | controller | repo_setup : Ensure directories are present ----------------------------- 0.53s 2025-10-02 20:59:44.214981 | controller | repo_setup : Dump full hash in delorean.repo.md5 file ------------------- 0.36s 2025-10-02 20:59:44.214989 | controller | test_deps : Disable ubi host subscription-manager integration ----------- 0.31s 2025-10-02 20:59:44.214995 | controller | repo_setup : Install repo-setup package --------------------------------- 0.29s 2025-10-02 20:59:44.215000 | controller | test_deps : Detect mirrors file ----------------------------------------- 0.28s 2025-10-02 20:59:44.215006 | controller | repo_setup : Use RDO CentOS mirrors (remove CentOS 10 conditional when Nodepool mirrors exist) --- 0.24s 2025-10-02 20:59:44.215011 | controller | repo_setup : Use RDO proxy mirrors -------------------------------------- 0.21s 2025-10-02 20:59:44.215017 | controller | repo_setup : Check for /etc/ci/mirror_info.sh --------------------------- 0.18s 2025-10-02 20:59:44.215022 | controller | Deploy repo-setup ------------------------------------------------------- 0.06s 2025-10-02 20:59:44.215027 | controller | repo_setup : Export hashes facts for further use ------------------------ 0.04s 2025-10-02 20:59:44.215050 | controller | INFO Running default > converge 2025-10-02 20:59:44.626594 | controller | 2025-10-02 20:59:45.472152 | controller | PLAY [Converge] **************************************************************** 2025-10-02 20:59:45.472185 | controller | 2025-10-02 20:59:45.472193 | controller | TASK [Gathering Facts] ********************************************************* 2025-10-02 20:59:45.472199 | controller | Thursday 02 October 2025 20:59:44 +0000 (0:00:00.034) 0:00:00.034 ****** 2025-10-02 20:59:45.472209 | controller | ok: [instance] 2025-10-02 20:59:45.552934 | controller | 2025-10-02 20:59:45.552971 | controller | TASK [Run repo-setup role] ***************************************************** 2025-10-02 20:59:45.552979 | controller | Thursday 02 October 2025 20:59:45 +0000 (0:00:00.845) 0:00:00.879 ****** 2025-10-02 20:59:45.553000 | controller | 2025-10-02 20:59:46.243517 | controller | TASK [repo_setup : Ensure directories are present] ***************************** 2025-10-02 20:59:46.243554 | controller | Thursday 02 October 2025 20:59:45 +0000 (0:00:00.080) 0:00:00.960 ****** 2025-10-02 20:59:46.243567 | controller | ok: [instance] => (item=tmp) 2025-10-02 20:59:46.243589 | controller | ok: [instance] => (item=artifacts/repositories) 2025-10-02 20:59:46.243596 | controller | ok: [instance] => (item=venv/repo_setup) 2025-10-02 20:59:46.243603 | controller | 2025-10-02 20:59:46.243778 | controller | TASK [repo_setup : Make sure git-core package is installed] ******************** 2025-10-02 20:59:47.636515 | controller | Thursday 02 October 2025 20:59:46 +0000 (0:00:00.691) 0:00:01.651 ****** 2025-10-02 20:59:47.636556 | controller | ok: [instance] 2025-10-02 20:59:47.636794 | controller | 2025-10-02 20:59:47.636808 | controller | TASK [repo_setup : Get repo-setup repository] ********************************** 2025-10-02 20:59:48.254323 | controller | Thursday 02 October 2025 20:59:47 +0000 (0:00:01.392) 0:00:03.044 ****** 2025-10-02 20:59:48.254369 | controller | ok: [instance] 2025-10-02 20:59:49.606138 | controller | 2025-10-02 20:59:49.606178 | controller | TASK [repo_setup : Initialize python venv and install requirements] ************ 2025-10-02 20:59:49.606186 | controller | Thursday 02 October 2025 20:59:48 +0000 (0:00:00.617) 0:00:03.661 ****** 2025-10-02 20:59:49.606205 | controller | ok: [instance] 2025-10-02 20:59:49.912351 | controller | 2025-10-02 20:59:49.912388 | controller | TASK [repo_setup : Install repo-setup package] ********************************* 2025-10-02 20:59:49.912397 | controller | Thursday 02 October 2025 20:59:49 +0000 (0:00:01.351) 0:00:05.013 ****** 2025-10-02 20:59:49.912408 | controller | ok: [instance] 2025-10-02 20:59:49.935310 | controller | 2025-10-02 20:59:49.935347 | controller | TASK [repo_setup : Set cifmw_repo_setup_dlrn_hash_tag from content provider] *** 2025-10-02 20:59:49.935355 | controller | Thursday 02 October 2025 20:59:49 +0000 (0:00:00.306) 0:00:05.319 ****** 2025-10-02 20:59:49.935369 | controller | skipping: [instance] 2025-10-02 20:59:50.772589 | controller | 2025-10-02 20:59:50.772625 | controller | TASK [repo_setup : Run repo-setup] ********************************************* 2025-10-02 20:59:50.772634 | controller | Thursday 02 October 2025 20:59:49 +0000 (0:00:00.023) 0:00:05.343 ****** 2025-10-02 20:59:50.772645 | controller | changed: [instance] 2025-10-02 20:59:50.811322 | controller | 2025-10-02 20:59:50.811355 | controller | TASK [repo_setup : Get component repo] ***************************************** 2025-10-02 20:59:50.811363 | controller | Thursday 02 October 2025 20:59:50 +0000 (0:00:00.837) 0:00:06.180 ****** 2025-10-02 20:59:50.811373 | controller | skipping: [instance] 2025-10-02 20:59:50.853147 | controller | 2025-10-02 20:59:50.853179 | controller | TASK [repo_setup : Rename component repo] ************************************** 2025-10-02 20:59:50.853188 | controller | Thursday 02 October 2025 20:59:50 +0000 (0:00:00.038) 0:00:06.219 ****** 2025-10-02 20:59:50.853198 | controller | skipping: [instance] 2025-10-02 20:59:50.894985 | controller | 2025-10-02 20:59:50.895016 | controller | TASK [repo_setup : Disable component repo in current-podified dlrn repo] ******* 2025-10-02 20:59:50.895026 | controller | Thursday 02 October 2025 20:59:50 +0000 (0:00:00.041) 0:00:06.260 ****** 2025-10-02 20:59:50.895038 | controller | skipping: [instance] 2025-10-02 20:59:51.450495 | controller | 2025-10-02 20:59:51.450530 | controller | TASK [repo_setup : Run repo-setup-get-hash] ************************************ 2025-10-02 20:59:51.450539 | controller | Thursday 02 October 2025 20:59:50 +0000 (0:00:00.041) 0:00:06.302 ****** 2025-10-02 20:59:51.450550 | controller | changed: [instance] 2025-10-02 20:59:52.022266 | controller | 2025-10-02 20:59:52.022302 | controller | TASK [repo_setup : Dump full hash in delorean.repo.md5 file] ******************* 2025-10-02 20:59:52.022311 | controller | Thursday 02 October 2025 20:59:51 +0000 (0:00:00.555) 0:00:06.858 ****** 2025-10-02 20:59:52.022321 | controller | changed: [instance] 2025-10-02 20:59:52.051984 | controller | 2025-10-02 20:59:52.052007 | controller | TASK [repo_setup : Dump current-podified hash] ********************************* 2025-10-02 20:59:52.052015 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.571) 0:00:07.430 ****** 2025-10-02 20:59:52.052025 | controller | skipping: [instance] 2025-10-02 20:59:52.081478 | controller | 2025-10-02 20:59:52.081505 | controller | TASK [repo_setup : Slurp current podified hash] ******************************** 2025-10-02 20:59:52.081512 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.029) 0:00:07.460 ****** 2025-10-02 20:59:52.081522 | controller | skipping: [instance] 2025-10-02 20:59:52.110641 | controller | 2025-10-02 20:59:52.110663 | controller | TASK [repo_setup : Update the value of full_hash] ****************************** 2025-10-02 20:59:52.110671 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.029) 0:00:07.489 ****** 2025-10-02 20:59:52.110680 | controller | skipping: [instance] 2025-10-02 20:59:52.149643 | controller | 2025-10-02 20:59:52.149667 | controller | TASK [repo_setup : Export hashes facts for further use] ************************ 2025-10-02 20:59:52.149674 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.029) 0:00:07.518 ****** 2025-10-02 20:59:52.149684 | controller | ok: [instance] 2025-10-02 20:59:52.177913 | controller | 2025-10-02 20:59:52.177936 | controller | TASK [repo_setup : Create download directory] ********************************** 2025-10-02 20:59:52.177945 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.038) 0:00:07.557 ****** 2025-10-02 20:59:52.177956 | controller | skipping: [instance] 2025-10-02 20:59:52.178148 | controller | 2025-10-02 20:59:52.178325 | controller | TASK [repo_setup : Print the URL to request] *********************************** 2025-10-02 20:59:52.178517 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.028) 0:00:07.586 ****** 2025-10-02 20:59:52.205911 | controller | skipping: [instance] 2025-10-02 20:59:52.206129 | controller | 2025-10-02 20:59:52.206309 | controller | TASK [Download the RPM] ******************************************************** 2025-10-02 20:59:52.206524 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.027) 0:00:07.614 ****** 2025-10-02 20:59:52.233920 | controller | skipping: [instance] 2025-10-02 20:59:52.234128 | controller | 2025-10-02 20:59:52.234305 | controller | TASK [repo_setup : Install RHOS Release tool] ********************************** 2025-10-02 20:59:52.234517 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.028) 0:00:07.642 ****** 2025-10-02 20:59:52.264705 | controller | skipping: [instance] 2025-10-02 20:59:52.264872 | controller | 2025-10-02 20:59:52.265033 | controller | TASK [repo_setup : Get rhos-release tool version] ****************************** 2025-10-02 20:59:52.265195 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.030) 0:00:07.673 ****** 2025-10-02 20:59:52.292464 | controller | skipping: [instance] 2025-10-02 20:59:52.292662 | controller | 2025-10-02 20:59:52.292815 | controller | TASK [repo_setup : Print rhos-release tool version] **************************** 2025-10-02 20:59:52.292956 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.027) 0:00:07.700 ****** 2025-10-02 20:59:52.322498 | controller | skipping: [instance] 2025-10-02 20:59:52.322697 | controller | 2025-10-02 20:59:52.322865 | controller | TASK [repo_setup : Generate repos using rhos-release {{ cifmw_repo_setup_rhos_release_args }}] *** 2025-10-02 20:59:52.323006 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.029) 0:00:07.730 ****** 2025-10-02 20:59:52.349427 | controller | skipping: [instance] 2025-10-02 20:59:52.349657 | controller | 2025-10-02 20:59:52.349833 | controller | TASK [repo_setup : Check for /etc/ci/mirror_info.sh] *************************** 2025-10-02 20:59:52.349985 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.027) 0:00:07.757 ****** 2025-10-02 20:59:52.535563 | controller | ok: [instance] 2025-10-02 20:59:52.535754 | controller | 2025-10-02 20:59:52.535766 | controller | TASK [repo_setup : Use RDO proxy mirrors] ************************************** 2025-10-02 20:59:52.535776 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.185) 0:00:07.943 ****** 2025-10-02 20:59:52.747523 | controller | changed: [instance] 2025-10-02 20:59:52.970255 | controller | 2025-10-02 20:59:52.970297 | controller | TASK [repo_setup : Use RDO CentOS mirrors (remove CentOS 10 conditional when Nodepool mirrors exist)] *** 2025-10-02 20:59:52.970306 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.212) 0:00:08.155 ****** 2025-10-02 20:59:52.970318 | controller | changed: [instance] 2025-10-02 20:59:52.996009 | controller | 2025-10-02 20:59:52.996047 | controller | TASK [repo_setup : Check for gating.repo file on content provider] ************* 2025-10-02 20:59:52.996071 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.222) 0:00:08.377 ****** 2025-10-02 20:59:52.996094 | controller | skipping: [instance] 2025-10-02 20:59:53.033922 | controller | 2025-10-02 20:59:53.033952 | controller | TASK [repo_setup : Populate gating repo from content provider ip] ************** 2025-10-02 20:59:53.033961 | controller | Thursday 02 October 2025 20:59:52 +0000 (0:00:00.026) 0:00:08.403 ****** 2025-10-02 20:59:53.033971 | controller | skipping: [instance] 2025-10-02 20:59:53.067163 | controller | 2025-10-02 20:59:53.067187 | controller | TASK [repo_setup : Check for DLRN repo at the destination] ********************* 2025-10-02 20:59:53.067195 | controller | Thursday 02 October 2025 20:59:53 +0000 (0:00:00.037) 0:00:08.441 ****** 2025-10-02 20:59:53.067205 | controller | skipping: [instance] 2025-10-02 20:59:53.100397 | controller | 2025-10-02 20:59:53.100420 | controller | TASK [repo_setup : Lower the priority of DLRN repos to allow installation from gating repo] *** 2025-10-02 20:59:53.100427 | controller | Thursday 02 October 2025 20:59:53 +0000 (0:00:00.033) 0:00:08.475 ****** 2025-10-02 20:59:53.100455 | controller | skipping: [instance] 2025-10-02 20:59:53.135353 | controller | 2025-10-02 20:59:53.135380 | controller | TASK [repo_setup : Check for DLRN component repo] ****************************** 2025-10-02 20:59:53.135389 | controller | Thursday 02 October 2025 20:59:53 +0000 (0:00:00.033) 0:00:08.508 ****** 2025-10-02 20:59:53.135400 | controller | skipping: [instance] 2025-10-02 20:59:53.190617 | controller | 2025-10-02 20:59:53.190654 | controller | TASK [repo_setup : Lower the priority of componennt repos to allow installation from gating repo] *** 2025-10-02 20:59:53.190664 | controller | Thursday 02 October 2025 20:59:53 +0000 (0:00:00.034) 0:00:08.543 ****** 2025-10-02 20:59:53.190676 | controller | skipping: [instance] 2025-10-02 20:59:53.190854 | controller | 2025-10-02 20:59:53.191035 | controller | TASK [repo_setup : Find existing repos from /etc/yum.repos.d directory] ******** 2025-10-02 20:59:53.191221 | controller | Thursday 02 October 2025 20:59:53 +0000 (0:00:00.055) 0:00:08.598 ****** 2025-10-02 20:59:53.495376 | controller | ok: [instance] 2025-10-02 20:59:55.090476 | controller | 2025-10-02 20:59:55.090512 | controller | TASK [repo_setup : Remove existing repos from /etc/yum.repos.d directory] ****** 2025-10-02 20:59:55.090521 | controller | Thursday 02 October 2025 20:59:53 +0000 (0:00:00.304) 0:00:08.903 ****** 2025-10-02 20:59:55.090532 | controller | changed: [instance] => (item=/etc/yum.repos.d/centos-addons.repo) 2025-10-02 20:59:55.544524 | controller | changed: [instance] => (item=/etc/yum.repos.d/centos.repo) 2025-10-02 20:59:55.544560 | controller | changed: [instance] => (item=/etc/yum.repos.d/repo-setup-centos-appstream.repo) 2025-10-02 20:59:55.544569 | controller | changed: [instance] => (item=/etc/yum.repos.d/repo-setup-centos-baseos.repo) 2025-10-02 20:59:55.544575 | controller | changed: [instance] => (item=/etc/yum.repos.d/delorean.repo) 2025-10-02 20:59:55.544580 | controller | changed: [instance] => (item=/etc/yum.repos.d/delorean-master-testing.repo) 2025-10-02 20:59:55.544586 | controller | changed: [instance] => (item=/etc/yum.repos.d/repo-setup-centos-highavailability.repo) 2025-10-02 20:59:55.544592 | controller | changed: [instance] => (item=/etc/yum.repos.d/repo-setup-centos-powertools.repo) 2025-10-02 20:59:55.544597 | controller | 2025-10-02 20:59:55.544603 | controller | TASK [repo_setup : Cleanup existing metadata] ********************************** 2025-10-02 20:59:55.544608 | controller | Thursday 02 October 2025 20:59:55 +0000 (0:00:01.594) 0:00:10.497 ****** 2025-10-02 20:59:55.544618 | controller | changed: [instance] 2025-10-02 20:59:55.767927 | controller | 2025-10-02 20:59:55.767963 | controller | TASK [repo_setup : Copy generated repos to /etc/yum.repos.d directory] ********* 2025-10-02 20:59:55.767983 | controller | Thursday 02 October 2025 20:59:55 +0000 (0:00:00.454) 0:00:10.952 ****** 2025-10-02 20:59:55.767996 | controller | changed: [instance] 2025-10-02 20:59:55.768014 | controller | 2025-10-02 20:59:55.768257 | controller | TASK [Check get_hashes playbook] *********************************************** 2025-10-02 20:59:55.823399 | controller | Thursday 02 October 2025 20:59:55 +0000 (0:00:00.223) 0:00:11.176 ****** 2025-10-02 20:59:55.823459 | controller | 2025-10-02 20:59:56.060893 | controller | TASK [dlrn_promote : Make sure delorean.repo exists] *************************** 2025-10-02 20:59:56.060940 | controller | Thursday 02 October 2025 20:59:55 +0000 (0:00:00.055) 0:00:11.231 ****** 2025-10-02 20:59:56.060961 | controller | ok: [instance] 2025-10-02 20:59:56.375828 | controller | 2025-10-02 20:59:56.375863 | controller | TASK [dlrn_promote : Get baseurls from delorean.repo] ************************** 2025-10-02 20:59:56.375871 | controller | Thursday 02 October 2025 20:59:56 +0000 (0:00:00.237) 0:00:11.468 ****** 2025-10-02 20:59:56.375882 | controller | ok: [instance] 2025-10-02 20:59:56.587607 | controller | 2025-10-02 20:59:56.587656 | controller | TASK [dlrn_promote : Get urls from baseurls list] ****************************** 2025-10-02 20:59:56.587667 | controller | Thursday 02 October 2025 20:59:56 +0000 (0:00:00.314) 0:00:11.782 ****** 2025-10-02 20:59:56.587682 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/barbican/42/b4/42b4c41831408a8e323fec3c8983b5c793b64874_08052e9d) 2025-10-02 20:59:56.587713 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/baremetal/10/df/10df0bd91b9bc5c9fd9cc02d75c0084cd4da29a7_36137eb3) 2025-10-02 20:59:56.587721 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/cinder/1c/00/1c00d6490d88e436f26efb71f2ac96e75252e97c_f716f000) 2025-10-02 20:59:56.587729 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/clients/c4/ac/c4acc5639fd2329372142e39464fcca0209b0018_d3ef8337) 2025-10-02 20:59:56.587735 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/cloudops/39/61/3961dcddb873b1ff6710d7df0739c4285dd71f8c_33e4dd93) 2025-10-02 20:59:56.587742 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/common/28/59/28598c2978b9e2207dd19fc4b14dc03573c2eb27_f77934fb) 2025-10-02 20:59:56.587756 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/compute/6f/8d/6f8decf0b4f1aa2e96292b6a2ffc28249fe4af5e_dc05b899) 2025-10-02 20:59:56.587763 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/designate/34/7f/347fdbc9b4595a10b726526b3c0b5928e5b7fcf2_3fd39337) 2025-10-02 20:59:56.587772 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/glance/1f/d1/1fd12c29b339f30fe823e2b5beba14b5f241e52a_0d693729) 2025-10-02 20:59:56.587812 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/keystone/e4/b4/e4b40af0ae3698fbbbbfb8c22468b33aae80e6d7_264c03cc) 2025-10-02 20:59:56.588511 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/manila/3c/01/3c01b7181572c95dac462eb19c3121e36cb0fe95_912dfd18) 2025-10-02 20:59:56.588874 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/network/59/2f/592f6dc961d1f9e7d1904ecbfb1e48eb4d09093d_3ed3aba3) 2025-10-02 20:59:56.588915 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/octavia/ba/39/ba397f07a7331190208c93368ee23826ac4e2707_9d6e596a) 2025-10-02 20:59:56.588923 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/optimize/c0/14/c014f81a8647287f6dcc339321c1256f5a2e82d5_bcbfdccc) 2025-10-02 20:59:56.588929 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/podified/55/ba/55ba53cf215b14ed95bc80c8e8ed4b29a45fd4ae_419d1901) 2025-10-02 20:59:56.588935 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/puppet/b0/c2/b0c245ccde541a63fde0564366c6a8247cf9fb4f_7cde1ad1) 2025-10-02 20:59:56.588945 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/swift/dc/98/dc98a8463506ac520c469adb0ef47d0f7753905a_9d02f069) 2025-10-02 20:59:56.588957 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/tempest/85/15/8515371b7cceebd4282e09f1d8f0cc842df82855_a1e336c7) 2025-10-02 20:59:56.783581 | controller | ok: [instance] => (item=baseurl=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/ui/01/3a/013accbfd179753bc3f0d1f4e5bed07a4fd9f771_0c88e467) 2025-10-02 20:59:56.783620 | controller | 2025-10-02 20:59:56.783630 | controller | TASK [dlrn_promote : Run promotion for each base component urls] *************** 2025-10-02 20:59:56.783638 | controller | Thursday 02 October 2025 20:59:56 +0000 (0:00:00.211) 0:00:11.994 ****** 2025-10-02 20:59:56.783655 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/barbican/42/b4/42b4c41831408a8e323fec3c8983b5c793b64874_08052e9d) 2025-10-02 20:59:56.783687 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/baremetal/10/df/10df0bd91b9bc5c9fd9cc02d75c0084cd4da29a7_36137eb3) 2025-10-02 20:59:56.783698 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/cinder/1c/00/1c00d6490d88e436f26efb71f2ac96e75252e97c_f716f000) 2025-10-02 20:59:56.783705 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/clients/c4/ac/c4acc5639fd2329372142e39464fcca0209b0018_d3ef8337) 2025-10-02 20:59:56.783712 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/cloudops/39/61/3961dcddb873b1ff6710d7df0739c4285dd71f8c_33e4dd93) 2025-10-02 20:59:56.783719 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/common/28/59/28598c2978b9e2207dd19fc4b14dc03573c2eb27_f77934fb) 2025-10-02 20:59:56.783727 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/compute/6f/8d/6f8decf0b4f1aa2e96292b6a2ffc28249fe4af5e_dc05b899) 2025-10-02 20:59:56.783763 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/designate/34/7f/347fdbc9b4595a10b726526b3c0b5928e5b7fcf2_3fd39337) 2025-10-02 20:59:56.785002 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/glance/1f/d1/1fd12c29b339f30fe823e2b5beba14b5f241e52a_0d693729) 2025-10-02 20:59:56.785057 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/keystone/e4/b4/e4b40af0ae3698fbbbbfb8c22468b33aae80e6d7_264c03cc) 2025-10-02 20:59:56.785080 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/manila/3c/01/3c01b7181572c95dac462eb19c3121e36cb0fe95_912dfd18) 2025-10-02 20:59:56.785087 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/network/59/2f/592f6dc961d1f9e7d1904ecbfb1e48eb4d09093d_3ed3aba3) 2025-10-02 20:59:56.785093 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/octavia/ba/39/ba397f07a7331190208c93368ee23826ac4e2707_9d6e596a) 2025-10-02 20:59:56.785098 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/optimize/c0/14/c014f81a8647287f6dcc339321c1256f5a2e82d5_bcbfdccc) 2025-10-02 20:59:56.785108 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/podified/55/ba/55ba53cf215b14ed95bc80c8e8ed4b29a45fd4ae_419d1901) 2025-10-02 20:59:56.785114 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/puppet/b0/c2/b0c245ccde541a63fde0564366c6a8247cf9fb4f_7cde1ad1) 2025-10-02 20:59:56.785119 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/swift/dc/98/dc98a8463506ac520c469adb0ef47d0f7753905a_9d02f069) 2025-10-02 20:59:56.785124 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/tempest/85/15/8515371b7cceebd4282e09f1d8f0cc842df82855_a1e336c7) 2025-10-02 20:59:56.785130 | controller | included: /home/zuul/src/github.com/openstack-k8s-operators/ci-framework/roles/dlrn_promote/tasks/get_hash_from_commit.yaml for instance => (item=http://mirror.regionone.ibm-bm4-nodepool.rdoproject.org:8080/rdo//centos9-antelope/component/ui/01/3a/013accbfd179753bc3f0d1f4e5bed07a4fd9f771_0c88e467) 2025-10-02 20:59:56.785135 | controller | 2025-10-02 20:59:56.785144 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 20:59:57.410466 | controller | Thursday 02 October 2025 20:59:56 +0000 (0:00:00.196) 0:00:12.190 ****** 2025-10-02 20:59:57.410509 | controller | changed: [instance] 2025-10-02 20:59:57.629542 | controller | 2025-10-02 20:59:57.629585 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 20:59:57.629594 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.627) 0:00:12.818 ****** 2025-10-02 20:59:57.629605 | controller | ok: [instance] 2025-10-02 20:59:57.667496 | controller | 2025-10-02 20:59:57.667540 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 20:59:57.667549 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.219) 0:00:13.037 ****** 2025-10-02 20:59:57.667560 | controller | ok: [instance] 2025-10-02 20:59:57.705918 | controller | 2025-10-02 20:59:57.705954 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 20:59:57.705967 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.038) 0:00:13.075 ****** 2025-10-02 20:59:57.705979 | controller | ok: [instance] 2025-10-02 20:59:57.740335 | controller | 2025-10-02 20:59:57.740356 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 20:59:57.740364 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.038) 0:00:13.113 ****** 2025-10-02 20:59:57.740373 | controller | skipping: [instance] 2025-10-02 20:59:57.775312 | controller | 2025-10-02 20:59:57.775331 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 20:59:57.775338 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.034) 0:00:13.148 ****** 2025-10-02 20:59:57.775347 | controller | skipping: [instance] 2025-10-02 20:59:57.814282 | controller | 2025-10-02 20:59:57.814300 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 20:59:57.814307 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.034) 0:00:13.183 ****** 2025-10-02 20:59:57.814316 | controller | ok: [instance] => 2025-10-02 20:59:57.847492 | controller | msg: 2025-10-02 20:59:57.847513 | controller | - 'Commit Hash: 42b4c41831408a8e323fec3c8983b5c793b64874' 2025-10-02 20:59:57.847523 | controller | - 'Distro Hash: 08052e9d9b38c81a7a6dd20de6e13eb78b3a47a6' 2025-10-02 20:59:57.847530 | controller | - 'Extended Hash: ' 2025-10-02 20:59:57.847537 | controller | - 'Full Hash: 42b4c41831408a8e323fec3c8983b5c793b64874_08052e9d' 2025-10-02 20:59:57.847544 | controller | 2025-10-02 20:59:57.847551 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 20:59:57.847557 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.038) 0:00:13.221 ****** 2025-10-02 20:59:57.847567 | controller | skipping: [instance] 2025-10-02 20:59:57.847882 | controller | 2025-10-02 20:59:57.847899 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 20:59:58.329646 | controller | Thursday 02 October 2025 20:59:57 +0000 (0:00:00.033) 0:00:13.255 ****** 2025-10-02 20:59:58.329688 | controller | changed: [instance] 2025-10-02 20:59:58.518198 | controller | 2025-10-02 20:59:58.518234 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 20:59:58.518243 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.481) 0:00:13.737 ****** 2025-10-02 20:59:58.518259 | controller | ok: [instance] 2025-10-02 20:59:58.556004 | controller | 2025-10-02 20:59:58.556034 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 20:59:58.556044 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.188) 0:00:13.926 ****** 2025-10-02 20:59:58.556055 | controller | ok: [instance] 2025-10-02 20:59:58.593357 | controller | 2025-10-02 20:59:58.593393 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 20:59:58.593403 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.037) 0:00:13.963 ****** 2025-10-02 20:59:58.593415 | controller | ok: [instance] 2025-10-02 20:59:58.626538 | controller | 2025-10-02 20:59:58.626578 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 20:59:58.626586 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.037) 0:00:14.001 ****** 2025-10-02 20:59:58.626598 | controller | skipping: [instance] 2025-10-02 20:59:58.659164 | controller | 2025-10-02 20:59:58.659190 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 20:59:58.659198 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.033) 0:00:14.034 ****** 2025-10-02 20:59:58.659208 | controller | skipping: [instance] 2025-10-02 20:59:58.697509 | controller | 2025-10-02 20:59:58.697532 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 20:59:58.697541 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.032) 0:00:14.067 ****** 2025-10-02 20:59:58.697550 | controller | ok: [instance] => 2025-10-02 20:59:58.697601 | controller | msg: 2025-10-02 20:59:58.697610 | controller | - 'Commit Hash: 10df0bd91b9bc5c9fd9cc02d75c0084cd4da29a7' 2025-10-02 20:59:58.697616 | controller | - 'Distro Hash: 36137eb30d837aacacddce802b71e00e1144495f' 2025-10-02 20:59:58.697621 | controller | - 'Extended Hash: ' 2025-10-02 20:59:58.697632 | controller | - 'Full Hash: 10df0bd91b9bc5c9fd9cc02d75c0084cd4da29a7_36137eb3' 2025-10-02 20:59:58.697638 | controller | 2025-10-02 20:59:58.697643 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 20:59:58.697650 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.037) 0:00:14.105 ****** 2025-10-02 20:59:58.731892 | controller | skipping: [instance] 2025-10-02 20:59:59.217524 | controller | 2025-10-02 20:59:59.217561 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 20:59:59.217569 | controller | Thursday 02 October 2025 20:59:58 +0000 (0:00:00.034) 0:00:14.139 ****** 2025-10-02 20:59:59.217580 | controller | changed: [instance] 2025-10-02 20:59:59.410686 | controller | 2025-10-02 20:59:59.410719 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 20:59:59.410728 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.485) 0:00:14.625 ****** 2025-10-02 20:59:59.410738 | controller | ok: [instance] 2025-10-02 20:59:59.448210 | controller | 2025-10-02 20:59:59.448236 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 20:59:59.448245 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.193) 0:00:14.818 ****** 2025-10-02 20:59:59.448257 | controller | ok: [instance] 2025-10-02 20:59:59.486985 | controller | 2025-10-02 20:59:59.487011 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 20:59:59.487019 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.037) 0:00:14.856 ****** 2025-10-02 20:59:59.487029 | controller | ok: [instance] 2025-10-02 20:59:59.521837 | controller | 2025-10-02 20:59:59.521868 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 20:59:59.521876 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.038) 0:00:14.894 ****** 2025-10-02 20:59:59.521886 | controller | skipping: [instance] 2025-10-02 20:59:59.556297 | controller | 2025-10-02 20:59:59.556322 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 20:59:59.556330 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.034) 0:00:14.929 ****** 2025-10-02 20:59:59.556339 | controller | skipping: [instance] 2025-10-02 20:59:59.596608 | controller | 2025-10-02 20:59:59.596652 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 20:59:59.596662 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.034) 0:00:14.964 ****** 2025-10-02 20:59:59.596675 | controller | ok: [instance] => 2025-10-02 20:59:59.596704 | controller | msg: 2025-10-02 20:59:59.596713 | controller | - 'Commit Hash: 1c00d6490d88e436f26efb71f2ac96e75252e97c' 2025-10-02 20:59:59.596720 | controller | - 'Distro Hash: f716f000a1f5c1bfea628f5aa01cee6a846fdc83' 2025-10-02 20:59:59.596728 | controller | - 'Extended Hash: ' 2025-10-02 20:59:59.596755 | controller | - 'Full Hash: 1c00d6490d88e436f26efb71f2ac96e75252e97c_f716f000' 2025-10-02 20:59:59.597044 | controller | 2025-10-02 20:59:59.630838 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 20:59:59.630864 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.040) 0:00:15.004 ****** 2025-10-02 20:59:59.630875 | controller | skipping: [instance] 2025-10-02 21:00:00.125156 | controller | 2025-10-02 21:00:00.125193 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:00.125202 | controller | Thursday 02 October 2025 20:59:59 +0000 (0:00:00.034) 0:00:15.038 ****** 2025-10-02 21:00:00.125213 | controller | changed: [instance] 2025-10-02 21:00:00.325819 | controller | 2025-10-02 21:00:00.325855 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:00.325869 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.494) 0:00:15.532 ****** 2025-10-02 21:00:00.325881 | controller | ok: [instance] 2025-10-02 21:00:00.363424 | controller | 2025-10-02 21:00:00.363469 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:00.363478 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.200) 0:00:15.733 ****** 2025-10-02 21:00:00.363488 | controller | ok: [instance] 2025-10-02 21:00:00.401993 | controller | 2025-10-02 21:00:00.402021 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:00.402037 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.037) 0:00:15.771 ****** 2025-10-02 21:00:00.402049 | controller | ok: [instance] 2025-10-02 21:00:00.436271 | controller | 2025-10-02 21:00:00.436302 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:00.436310 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.038) 0:00:15.809 ****** 2025-10-02 21:00:00.436320 | controller | skipping: [instance] 2025-10-02 21:00:00.470185 | controller | 2025-10-02 21:00:00.470210 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:00.470218 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.034) 0:00:15.844 ****** 2025-10-02 21:00:00.470227 | controller | skipping: [instance] 2025-10-02 21:00:00.509507 | controller | 2025-10-02 21:00:00.509533 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:00.509541 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.033) 0:00:15.878 ****** 2025-10-02 21:00:00.509550 | controller | ok: [instance] => 2025-10-02 21:00:00.543140 | controller | msg: 2025-10-02 21:00:00.543168 | controller | - 'Commit Hash: c4acc5639fd2329372142e39464fcca0209b0018' 2025-10-02 21:00:00.543178 | controller | - 'Distro Hash: d3ef83374427f80feb30d6883ae9dd9d85110091' 2025-10-02 21:00:00.543185 | controller | - 'Extended Hash: ' 2025-10-02 21:00:00.543193 | controller | - 'Full Hash: c4acc5639fd2329372142e39464fcca0209b0018_d3ef8337' 2025-10-02 21:00:00.543200 | controller | 2025-10-02 21:00:00.543214 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:00.543221 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.038) 0:00:15.917 ****** 2025-10-02 21:00:00.543232 | controller | skipping: [instance] 2025-10-02 21:00:01.037301 | controller | 2025-10-02 21:00:01.037337 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:01.037346 | controller | Thursday 02 October 2025 21:00:00 +0000 (0:00:00.033) 0:00:15.951 ****** 2025-10-02 21:00:01.037356 | controller | changed: [instance] 2025-10-02 21:00:01.234641 | controller | 2025-10-02 21:00:01.234677 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:01.234686 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.494) 0:00:16.445 ****** 2025-10-02 21:00:01.234696 | controller | ok: [instance] 2025-10-02 21:00:01.273604 | controller | 2025-10-02 21:00:01.273655 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:01.273665 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.197) 0:00:16.642 ****** 2025-10-02 21:00:01.273681 | controller | ok: [instance] 2025-10-02 21:00:01.311949 | controller | 2025-10-02 21:00:01.311989 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:01.311997 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.039) 0:00:16.681 ****** 2025-10-02 21:00:01.312008 | controller | ok: [instance] 2025-10-02 21:00:01.346557 | controller | 2025-10-02 21:00:01.346607 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:01.346616 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.038) 0:00:16.719 ****** 2025-10-02 21:00:01.346628 | controller | skipping: [instance] 2025-10-02 21:00:01.381968 | controller | 2025-10-02 21:00:01.382003 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:01.382012 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.034) 0:00:16.754 ****** 2025-10-02 21:00:01.382022 | controller | skipping: [instance] 2025-10-02 21:00:01.419537 | controller | 2025-10-02 21:00:01.419577 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:01.419588 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.035) 0:00:16.789 ****** 2025-10-02 21:00:01.419600 | controller | ok: [instance] => 2025-10-02 21:00:01.420581 | controller | msg: 2025-10-02 21:00:01.453935 | controller | - 'Commit Hash: 3961dcddb873b1ff6710d7df0739c4285dd71f8c' 2025-10-02 21:00:01.453966 | controller | - 'Distro Hash: 33e4dd933a98a26040e7af3ea96822cfb2d33e9e' 2025-10-02 21:00:01.453976 | controller | - 'Extended Hash: ' 2025-10-02 21:00:01.453990 | controller | - 'Full Hash: 3961dcddb873b1ff6710d7df0739c4285dd71f8c_33e4dd93' 2025-10-02 21:00:01.453997 | controller | 2025-10-02 21:00:01.454004 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:01.454011 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.037) 0:00:16.827 ****** 2025-10-02 21:00:01.454023 | controller | skipping: [instance] 2025-10-02 21:00:01.959931 | controller | 2025-10-02 21:00:01.959967 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:01.959975 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.034) 0:00:16.861 ****** 2025-10-02 21:00:01.959992 | controller | changed: [instance] 2025-10-02 21:00:02.171651 | controller | 2025-10-02 21:00:02.171686 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:02.171695 | controller | Thursday 02 October 2025 21:00:01 +0000 (0:00:00.505) 0:00:17.367 ****** 2025-10-02 21:00:02.171705 | controller | ok: [instance] 2025-10-02 21:00:02.210983 | controller | 2025-10-02 21:00:02.211020 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:02.211028 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.211) 0:00:17.579 ****** 2025-10-02 21:00:02.211039 | controller | ok: [instance] 2025-10-02 21:00:02.252530 | controller | 2025-10-02 21:00:02.252568 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:02.252576 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.039) 0:00:17.618 ****** 2025-10-02 21:00:02.252587 | controller | ok: [instance] 2025-10-02 21:00:02.290609 | controller | 2025-10-02 21:00:02.290665 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:02.290675 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.041) 0:00:17.660 ****** 2025-10-02 21:00:02.290689 | controller | skipping: [instance] 2025-10-02 21:00:02.325150 | controller | 2025-10-02 21:00:02.325189 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:02.325205 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.038) 0:00:17.698 ****** 2025-10-02 21:00:02.325217 | controller | skipping: [instance] 2025-10-02 21:00:02.365450 | controller | 2025-10-02 21:00:02.365485 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:02.365494 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.034) 0:00:17.733 ****** 2025-10-02 21:00:02.365504 | controller | ok: [instance] => 2025-10-02 21:00:02.404602 | controller | msg: 2025-10-02 21:00:02.404652 | controller | - 'Commit Hash: 28598c2978b9e2207dd19fc4b14dc03573c2eb27' 2025-10-02 21:00:02.404662 | controller | - 'Distro Hash: f77934fbd9bbd9df4322c84df180d383a04a5f90' 2025-10-02 21:00:02.404670 | controller | - 'Extended Hash: ' 2025-10-02 21:00:02.404677 | controller | - 'Full Hash: 28598c2978b9e2207dd19fc4b14dc03573c2eb27_f77934fb' 2025-10-02 21:00:02.404684 | controller | 2025-10-02 21:00:02.404691 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:02.404698 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.039) 0:00:17.772 ****** 2025-10-02 21:00:02.404710 | controller | skipping: [instance] 2025-10-02 21:00:02.404740 | controller | 2025-10-02 21:00:02.404748 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:02.404930 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.039) 0:00:17.812 ****** 2025-10-02 21:00:02.901282 | controller | changed: [instance] 2025-10-02 21:00:03.098652 | controller | 2025-10-02 21:00:03.098687 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:03.098695 | controller | Thursday 02 October 2025 21:00:02 +0000 (0:00:00.496) 0:00:18.308 ****** 2025-10-02 21:00:03.098706 | controller | ok: [instance] 2025-10-02 21:00:03.136726 | controller | 2025-10-02 21:00:03.136757 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:03.136764 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.197) 0:00:18.506 ****** 2025-10-02 21:00:03.136775 | controller | ok: [instance] 2025-10-02 21:00:03.176274 | controller | 2025-10-02 21:00:03.176303 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:03.176318 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.038) 0:00:18.544 ****** 2025-10-02 21:00:03.176331 | controller | ok: [instance] 2025-10-02 21:00:03.211908 | controller | 2025-10-02 21:00:03.211932 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:03.211941 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.039) 0:00:18.584 ****** 2025-10-02 21:00:03.211953 | controller | skipping: [instance] 2025-10-02 21:00:03.247244 | controller | 2025-10-02 21:00:03.247269 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:03.247278 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.035) 0:00:18.619 ****** 2025-10-02 21:00:03.247289 | controller | skipping: [instance] 2025-10-02 21:00:03.287505 | controller | 2025-10-02 21:00:03.287531 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:03.287539 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.035) 0:00:18.655 ****** 2025-10-02 21:00:03.287551 | controller | ok: [instance] => 2025-10-02 21:00:03.287702 | controller | msg: 2025-10-02 21:00:03.287845 | controller | - 'Commit Hash: 6f8decf0b4f1aa2e96292b6a2ffc28249fe4af5e' 2025-10-02 21:00:03.287983 | controller | - 'Distro Hash: dc05b8990d42402ddb4135e94728608511ecf5b4' 2025-10-02 21:00:03.288135 | controller | - 'Extended Hash: ' 2025-10-02 21:00:03.288283 | controller | - 'Full Hash: 6f8decf0b4f1aa2e96292b6a2ffc28249fe4af5e_dc05b899' 2025-10-02 21:00:03.288410 | controller | 2025-10-02 21:00:03.288572 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:03.288716 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.040) 0:00:18.695 ****** 2025-10-02 21:00:03.322611 | controller | skipping: [instance] 2025-10-02 21:00:03.322761 | controller | 2025-10-02 21:00:03.322899 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:03.323042 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.035) 0:00:18.730 ****** 2025-10-02 21:00:03.824042 | controller | changed: [instance] 2025-10-02 21:00:04.018800 | controller | 2025-10-02 21:00:04.018837 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:04.018846 | controller | Thursday 02 October 2025 21:00:03 +0000 (0:00:00.500) 0:00:19.231 ****** 2025-10-02 21:00:04.018857 | controller | ok: [instance] 2025-10-02 21:00:04.056985 | controller | 2025-10-02 21:00:04.057025 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:04.057034 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.194) 0:00:19.426 ****** 2025-10-02 21:00:04.057048 | controller | ok: [instance] 2025-10-02 21:00:04.095616 | controller | 2025-10-02 21:00:04.095649 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:04.095657 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.038) 0:00:19.464 ****** 2025-10-02 21:00:04.095668 | controller | ok: [instance] 2025-10-02 21:00:04.130796 | controller | 2025-10-02 21:00:04.130830 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:04.130839 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.038) 0:00:19.503 ****** 2025-10-02 21:00:04.130852 | controller | skipping: [instance] 2025-10-02 21:00:04.165188 | controller | 2025-10-02 21:00:04.165227 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:04.165236 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.035) 0:00:19.538 ****** 2025-10-02 21:00:04.165246 | controller | skipping: [instance] 2025-10-02 21:00:04.206809 | controller | 2025-10-02 21:00:04.206850 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:04.206860 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.034) 0:00:19.572 ****** 2025-10-02 21:00:04.206873 | controller | ok: [instance] => 2025-10-02 21:00:04.207056 | controller | msg: 2025-10-02 21:00:04.207247 | controller | - 'Commit Hash: 347fdbc9b4595a10b726526b3c0b5928e5b7fcf2' 2025-10-02 21:00:04.207406 | controller | - 'Distro Hash: 3fd39337c631f89be60419b65642da6b614e1f63' 2025-10-02 21:00:04.207576 | controller | - 'Extended Hash: ' 2025-10-02 21:00:04.207729 | controller | - 'Full Hash: 347fdbc9b4595a10b726526b3c0b5928e5b7fcf2_3fd39337' 2025-10-02 21:00:04.207860 | controller | 2025-10-02 21:00:04.207993 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:04.208142 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.041) 0:00:19.614 ****** 2025-10-02 21:00:04.244038 | controller | skipping: [instance] 2025-10-02 21:00:04.244229 | controller | 2025-10-02 21:00:04.244374 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:04.244539 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.037) 0:00:19.652 ****** 2025-10-02 21:00:04.731535 | controller | changed: [instance] 2025-10-02 21:00:04.731664 | controller | 2025-10-02 21:00:04.731699 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:04.731712 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.487) 0:00:20.139 ****** 2025-10-02 21:00:04.933532 | controller | ok: [instance] 2025-10-02 21:00:04.933568 | controller | 2025-10-02 21:00:04.933576 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:04.933585 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.201) 0:00:20.341 ****** 2025-10-02 21:00:04.971261 | controller | ok: [instance] 2025-10-02 21:00:05.009621 | controller | 2025-10-02 21:00:05.009660 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:05.009670 | controller | Thursday 02 October 2025 21:00:04 +0000 (0:00:00.037) 0:00:20.379 ****** 2025-10-02 21:00:05.009683 | controller | ok: [instance] 2025-10-02 21:00:05.044553 | controller | 2025-10-02 21:00:05.044587 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:05.044596 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.038) 0:00:20.417 ****** 2025-10-02 21:00:05.044607 | controller | skipping: [instance] 2025-10-02 21:00:05.080458 | controller | 2025-10-02 21:00:05.080494 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:05.080503 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.035) 0:00:20.452 ****** 2025-10-02 21:00:05.080515 | controller | skipping: [instance] 2025-10-02 21:00:05.080699 | controller | 2025-10-02 21:00:05.080876 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:05.081036 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.036) 0:00:20.488 ****** 2025-10-02 21:00:05.119888 | controller | ok: [instance] => 2025-10-02 21:00:05.120060 | controller | msg: 2025-10-02 21:00:05.120223 | controller | - 'Commit Hash: 1fd12c29b339f30fe823e2b5beba14b5f241e52a' 2025-10-02 21:00:05.120363 | controller | - 'Distro Hash: 0d69372941efaea8b5f054a1deea5da22dcf719f' 2025-10-02 21:00:05.120556 | controller | - 'Extended Hash: ' 2025-10-02 21:00:05.120709 | controller | - 'Full Hash: 1fd12c29b339f30fe823e2b5beba14b5f241e52a_0d693729' 2025-10-02 21:00:05.120848 | controller | 2025-10-02 21:00:05.120986 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:05.121140 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.039) 0:00:20.528 ****** 2025-10-02 21:00:05.154582 | controller | skipping: [instance] 2025-10-02 21:00:05.154780 | controller | 2025-10-02 21:00:05.154951 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:05.155132 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.034) 0:00:20.562 ****** 2025-10-02 21:00:05.645424 | controller | changed: [instance] 2025-10-02 21:00:05.848535 | controller | 2025-10-02 21:00:05.848582 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:05.848591 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.490) 0:00:21.053 ****** 2025-10-02 21:00:05.848602 | controller | ok: [instance] 2025-10-02 21:00:05.886222 | controller | 2025-10-02 21:00:05.886260 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:05.886270 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.203) 0:00:21.256 ****** 2025-10-02 21:00:05.886282 | controller | ok: [instance] 2025-10-02 21:00:05.924309 | controller | 2025-10-02 21:00:05.924349 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:05.924365 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.037) 0:00:21.293 ****** 2025-10-02 21:00:05.924379 | controller | ok: [instance] 2025-10-02 21:00:05.958310 | controller | 2025-10-02 21:00:05.958345 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:05.958355 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.038) 0:00:21.331 ****** 2025-10-02 21:00:05.958367 | controller | skipping: [instance] 2025-10-02 21:00:05.992506 | controller | 2025-10-02 21:00:05.992541 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:05.992550 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.034) 0:00:21.366 ****** 2025-10-02 21:00:05.992563 | controller | skipping: [instance] 2025-10-02 21:00:05.992742 | controller | 2025-10-02 21:00:05.992894 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:05.993035 | controller | Thursday 02 October 2025 21:00:05 +0000 (0:00:00.034) 0:00:21.400 ****** 2025-10-02 21:00:06.031708 | controller | ok: [instance] => 2025-10-02 21:00:06.031891 | controller | msg: 2025-10-02 21:00:06.032035 | controller | - 'Commit Hash: e4b40af0ae3698fbbbbfb8c22468b33aae80e6d7' 2025-10-02 21:00:06.032185 | controller | - 'Distro Hash: 264c03cc165183f13c27593de11341e21fc08637' 2025-10-02 21:00:06.032324 | controller | - 'Extended Hash: ' 2025-10-02 21:00:06.032484 | controller | - 'Full Hash: e4b40af0ae3698fbbbbfb8c22468b33aae80e6d7_264c03cc' 2025-10-02 21:00:06.032621 | controller | 2025-10-02 21:00:06.032757 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:06.032888 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.039) 0:00:21.439 ****** 2025-10-02 21:00:06.064245 | controller | skipping: [instance] 2025-10-02 21:00:06.064483 | controller | 2025-10-02 21:00:06.064680 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:06.064863 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.032) 0:00:21.472 ****** 2025-10-02 21:00:06.547301 | controller | changed: [instance] 2025-10-02 21:00:06.735575 | controller | 2025-10-02 21:00:06.735613 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:06.735622 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.482) 0:00:21.955 ****** 2025-10-02 21:00:06.735633 | controller | ok: [instance] 2025-10-02 21:00:06.773019 | controller | 2025-10-02 21:00:06.773044 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:06.773053 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.188) 0:00:22.143 ****** 2025-10-02 21:00:06.773065 | controller | ok: [instance] 2025-10-02 21:00:06.810071 | controller | 2025-10-02 21:00:06.810090 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:06.810098 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.037) 0:00:22.180 ****** 2025-10-02 21:00:06.810122 | controller | ok: [instance] 2025-10-02 21:00:06.843376 | controller | 2025-10-02 21:00:06.843393 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:06.843400 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.037) 0:00:22.218 ****** 2025-10-02 21:00:06.843409 | controller | skipping: [instance] 2025-10-02 21:00:06.875608 | controller | 2025-10-02 21:00:06.875623 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:06.875630 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.033) 0:00:22.251 ****** 2025-10-02 21:00:06.875638 | controller | skipping: [instance] 2025-10-02 21:00:06.913484 | controller | 2025-10-02 21:00:06.913503 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:06.913510 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.032) 0:00:22.283 ****** 2025-10-02 21:00:06.913518 | controller | ok: [instance] => 2025-10-02 21:00:06.913540 | controller | msg: 2025-10-02 21:00:06.914368 | controller | - 'Commit Hash: 3c01b7181572c95dac462eb19c3121e36cb0fe95' 2025-10-02 21:00:06.988559 | controller | - 'Distro Hash: 912dfd188ece75998eaa520827a3687e49d47907' 2025-10-02 21:00:06.988589 | controller | - 'Extended Hash: ' 2025-10-02 21:00:06.988604 | controller | - 'Full Hash: 3c01b7181572c95dac462eb19c3121e36cb0fe95_912dfd18' 2025-10-02 21:00:06.988612 | controller | 2025-10-02 21:00:06.988619 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:06.988629 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.038) 0:00:22.321 ****** 2025-10-02 21:00:06.988638 | controller | skipping: [instance] 2025-10-02 21:00:08.505911 | controller | 2025-10-02 21:00:08.505946 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:08.505955 | controller | Thursday 02 October 2025 21:00:06 +0000 (0:00:00.074) 0:00:22.396 ****** 2025-10-02 21:00:08.505966 | controller | changed: [instance] 2025-10-02 21:00:08.700089 | controller | 2025-10-02 21:00:08.700152 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:08.700349 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:01.517) 0:00:23.913 ****** 2025-10-02 21:00:08.700359 | controller | ok: [instance] 2025-10-02 21:00:08.737045 | controller | 2025-10-02 21:00:08.737067 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:08.737075 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:00.193) 0:00:24.107 ****** 2025-10-02 21:00:08.737085 | controller | ok: [instance] 2025-10-02 21:00:08.775512 | controller | 2025-10-02 21:00:08.775543 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:08.775552 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:00.037) 0:00:24.145 ****** 2025-10-02 21:00:08.775563 | controller | ok: [instance] 2025-10-02 21:00:08.775585 | controller | 2025-10-02 21:00:08.775671 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:08.775782 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:00.038) 0:00:24.183 ****** 2025-10-02 21:00:08.810511 | controller | skipping: [instance] 2025-10-02 21:00:08.843552 | controller | 2025-10-02 21:00:08.843590 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:08.843599 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:00.034) 0:00:24.218 ****** 2025-10-02 21:00:08.843610 | controller | skipping: [instance] 2025-10-02 21:00:08.843635 | controller | 2025-10-02 21:00:08.843643 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:08.843786 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:00.033) 0:00:24.251 ****** 2025-10-02 21:00:08.884552 | controller | ok: [instance] => 2025-10-02 21:00:08.884606 | controller | msg: 2025-10-02 21:00:08.884615 | controller | - 'Commit Hash: 592f6dc961d1f9e7d1904ecbfb1e48eb4d09093d' 2025-10-02 21:00:08.884621 | controller | - 'Distro Hash: 3ed3aba3c4fa00095b87a3c01c44f53c0990d272' 2025-10-02 21:00:08.884627 | controller | - 'Extended Hash: ' 2025-10-02 21:00:08.884633 | controller | - 'Full Hash: 592f6dc961d1f9e7d1904ecbfb1e48eb4d09093d_3ed3aba3' 2025-10-02 21:00:08.884641 | controller | 2025-10-02 21:00:08.884663 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:08.884798 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:00.040) 0:00:24.292 ****** 2025-10-02 21:00:08.919226 | controller | skipping: [instance] 2025-10-02 21:00:08.919282 | controller | 2025-10-02 21:00:08.919336 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:08.919472 | controller | Thursday 02 October 2025 21:00:08 +0000 (0:00:00.035) 0:00:24.327 ****** 2025-10-02 21:00:09.410125 | controller | changed: [instance] 2025-10-02 21:00:09.601954 | controller | 2025-10-02 21:00:09.601988 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:09.601997 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.490) 0:00:24.817 ****** 2025-10-02 21:00:09.602008 | controller | ok: [instance] 2025-10-02 21:00:09.639469 | controller | 2025-10-02 21:00:09.639490 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:09.639498 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.191) 0:00:25.009 ****** 2025-10-02 21:00:09.639507 | controller | ok: [instance] 2025-10-02 21:00:09.675529 | controller | 2025-10-02 21:00:09.675564 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:09.675578 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.037) 0:00:25.047 ****** 2025-10-02 21:00:09.675589 | controller | ok: [instance] 2025-10-02 21:00:09.675610 | controller | 2025-10-02 21:00:09.675618 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:09.710275 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.036) 0:00:25.083 ****** 2025-10-02 21:00:09.710327 | controller | skipping: [instance] 2025-10-02 21:00:09.710349 | controller | 2025-10-02 21:00:09.710547 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:09.710631 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.034) 0:00:25.118 ****** 2025-10-02 21:00:09.744958 | controller | skipping: [instance] 2025-10-02 21:00:09.783357 | controller | 2025-10-02 21:00:09.783379 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:09.783387 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.034) 0:00:25.153 ****** 2025-10-02 21:00:09.783400 | controller | ok: [instance] => 2025-10-02 21:00:09.817295 | controller | msg: 2025-10-02 21:00:09.817324 | controller | - 'Commit Hash: ba397f07a7331190208c93368ee23826ac4e2707' 2025-10-02 21:00:09.817333 | controller | - 'Distro Hash: 9d6e596a15e166e2cafd87cd8c461148f963eb24' 2025-10-02 21:00:09.817339 | controller | - 'Extended Hash: ' 2025-10-02 21:00:09.817346 | controller | - 'Full Hash: ba397f07a7331190208c93368ee23826ac4e2707_9d6e596a' 2025-10-02 21:00:09.817351 | controller | 2025-10-02 21:00:09.817357 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:09.817363 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.037) 0:00:25.190 ****** 2025-10-02 21:00:09.817373 | controller | skipping: [instance] 2025-10-02 21:00:10.305523 | controller | 2025-10-02 21:00:10.305559 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:10.305567 | controller | Thursday 02 October 2025 21:00:09 +0000 (0:00:00.034) 0:00:25.225 ****** 2025-10-02 21:00:10.305578 | controller | changed: [instance] 2025-10-02 21:00:10.498576 | controller | 2025-10-02 21:00:10.498611 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:10.498620 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.488) 0:00:25.713 ****** 2025-10-02 21:00:10.498631 | controller | ok: [instance] 2025-10-02 21:00:10.537547 | controller | 2025-10-02 21:00:10.537584 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:10.537593 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.193) 0:00:25.906 ****** 2025-10-02 21:00:10.537604 | controller | ok: [instance] 2025-10-02 21:00:10.537628 | controller | 2025-10-02 21:00:10.537648 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:10.537775 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.039) 0:00:25.945 ****** 2025-10-02 21:00:10.576189 | controller | ok: [instance] 2025-10-02 21:00:10.610373 | controller | 2025-10-02 21:00:10.610407 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:10.610417 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.038) 0:00:25.983 ****** 2025-10-02 21:00:10.610429 | controller | skipping: [instance] 2025-10-02 21:00:10.643989 | controller | 2025-10-02 21:00:10.644020 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:10.644030 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.034) 0:00:26.018 ****** 2025-10-02 21:00:10.644041 | controller | skipping: [instance] 2025-10-02 21:00:10.683590 | controller | 2025-10-02 21:00:10.683628 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:10.683638 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.033) 0:00:26.051 ****** 2025-10-02 21:00:10.683651 | controller | ok: [instance] => 2025-10-02 21:00:10.683688 | controller | msg: 2025-10-02 21:00:10.683701 | controller | - 'Commit Hash: c014f81a8647287f6dcc339321c1256f5a2e82d5' 2025-10-02 21:00:10.683708 | controller | - 'Distro Hash: bcbfdccc8f5b03eea0d8708dcfc1123a723c6be6' 2025-10-02 21:00:10.683715 | controller | - 'Extended Hash: ' 2025-10-02 21:00:10.683728 | controller | - 'Full Hash: c014f81a8647287f6dcc339321c1256f5a2e82d5_bcbfdccc' 2025-10-02 21:00:10.683735 | controller | 2025-10-02 21:00:10.683744 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:10.683818 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.039) 0:00:26.090 ****** 2025-10-02 21:00:10.716961 | controller | skipping: [instance] 2025-10-02 21:00:10.717079 | controller | 2025-10-02 21:00:10.717294 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:10.717410 | controller | Thursday 02 October 2025 21:00:10 +0000 (0:00:00.034) 0:00:26.125 ****** 2025-10-02 21:00:11.206301 | controller | changed: [instance] 2025-10-02 21:00:11.394908 | controller | 2025-10-02 21:00:11.394947 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:11.394955 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.488) 0:00:26.614 ****** 2025-10-02 21:00:11.394966 | controller | ok: [instance] 2025-10-02 21:00:11.432518 | controller | 2025-10-02 21:00:11.432545 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:11.432555 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.188) 0:00:26.802 ****** 2025-10-02 21:00:11.432566 | controller | ok: [instance] 2025-10-02 21:00:11.432594 | controller | 2025-10-02 21:00:11.432833 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:11.472453 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.038) 0:00:26.840 ****** 2025-10-02 21:00:11.472478 | controller | ok: [instance] 2025-10-02 21:00:11.506957 | controller | 2025-10-02 21:00:11.506976 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:11.506985 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.039) 0:00:26.880 ****** 2025-10-02 21:00:11.506995 | controller | skipping: [instance] 2025-10-02 21:00:11.541928 | controller | 2025-10-02 21:00:11.541948 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:11.541956 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.034) 0:00:26.915 ****** 2025-10-02 21:00:11.541967 | controller | skipping: [instance] 2025-10-02 21:00:11.580865 | controller | 2025-10-02 21:00:11.580886 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:11.580898 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.034) 0:00:26.950 ****** 2025-10-02 21:00:11.580909 | controller | ok: [instance] => 2025-10-02 21:00:11.581082 | controller | msg: 2025-10-02 21:00:11.581272 | controller | - 'Commit Hash: 55ba53cf215b14ed95bc80c8e8ed4b29a45fd4ae' 2025-10-02 21:00:11.581422 | controller | - 'Distro Hash: 419d1901a102bc3cdc217a3311d92f945f3263ac' 2025-10-02 21:00:11.581590 | controller | - 'Extended Hash: ' 2025-10-02 21:00:11.581735 | controller | - 'Full Hash: 55ba53cf215b14ed95bc80c8e8ed4b29a45fd4ae_419d1901' 2025-10-02 21:00:11.581866 | controller | 2025-10-02 21:00:11.582004 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:11.582155 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.039) 0:00:26.989 ****** 2025-10-02 21:00:11.617610 | controller | skipping: [instance] 2025-10-02 21:00:11.617781 | controller | 2025-10-02 21:00:11.617989 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:11.618144 | controller | Thursday 02 October 2025 21:00:11 +0000 (0:00:00.036) 0:00:27.025 ****** 2025-10-02 21:00:12.100592 | controller | changed: [instance] 2025-10-02 21:00:12.293528 | controller | 2025-10-02 21:00:12.293565 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:12.293574 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.482) 0:00:27.508 ****** 2025-10-02 21:00:12.293584 | controller | ok: [instance] 2025-10-02 21:00:12.330347 | controller | 2025-10-02 21:00:12.330381 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:12.330389 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.192) 0:00:27.701 ****** 2025-10-02 21:00:12.330400 | controller | ok: [instance] 2025-10-02 21:00:12.375364 | controller | 2025-10-02 21:00:12.375400 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:12.375414 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.036) 0:00:27.738 ****** 2025-10-02 21:00:12.375426 | controller | ok: [instance] 2025-10-02 21:00:12.410065 | controller | 2025-10-02 21:00:12.410093 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:12.410101 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.044) 0:00:27.783 ****** 2025-10-02 21:00:12.410111 | controller | skipping: [instance] 2025-10-02 21:00:12.442575 | controller | 2025-10-02 21:00:12.442617 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:12.442627 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.034) 0:00:27.818 ****** 2025-10-02 21:00:12.442640 | controller | skipping: [instance] 2025-10-02 21:00:12.442668 | controller | 2025-10-02 21:00:12.442678 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:12.442787 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.032) 0:00:27.850 ****** 2025-10-02 21:00:12.479539 | controller | ok: [instance] => 2025-10-02 21:00:12.479584 | controller | msg: 2025-10-02 21:00:12.479596 | controller | - 'Commit Hash: b0c245ccde541a63fde0564366c6a8247cf9fb4f' 2025-10-02 21:00:12.480111 | controller | - 'Distro Hash: 7cde1ad1a2bae194d58954938ee5a3fb267415a1' 2025-10-02 21:00:12.511559 | controller | - 'Extended Hash: ' 2025-10-02 21:00:12.511581 | controller | - 'Full Hash: b0c245ccde541a63fde0564366c6a8247cf9fb4f_7cde1ad1' 2025-10-02 21:00:12.511589 | controller | 2025-10-02 21:00:12.511595 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:12.511601 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.037) 0:00:27.887 ****** 2025-10-02 21:00:12.511610 | controller | skipping: [instance] 2025-10-02 21:00:12.993542 | controller | 2025-10-02 21:00:12.993578 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:12.993586 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.031) 0:00:27.919 ****** 2025-10-02 21:00:12.993596 | controller | changed: [instance] 2025-10-02 21:00:12.993885 | controller | 2025-10-02 21:00:12.993899 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:13.191522 | controller | Thursday 02 October 2025 21:00:12 +0000 (0:00:00.481) 0:00:28.401 ****** 2025-10-02 21:00:13.191562 | controller | ok: [instance] 2025-10-02 21:00:13.191586 | controller | 2025-10-02 21:00:13.191593 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:13.191600 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.197) 0:00:28.599 ****** 2025-10-02 21:00:13.228944 | controller | ok: [instance] 2025-10-02 21:00:13.266717 | controller | 2025-10-02 21:00:13.266750 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:13.266758 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.037) 0:00:28.636 ****** 2025-10-02 21:00:13.266769 | controller | ok: [instance] 2025-10-02 21:00:13.302060 | controller | 2025-10-02 21:00:13.302091 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:13.302100 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.037) 0:00:28.674 ****** 2025-10-02 21:00:13.302112 | controller | skipping: [instance] 2025-10-02 21:00:13.336429 | controller | 2025-10-02 21:00:13.336483 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:13.336492 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.035) 0:00:28.709 ****** 2025-10-02 21:00:13.336509 | controller | skipping: [instance] 2025-10-02 21:00:13.336693 | controller | 2025-10-02 21:00:13.336848 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:13.336990 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.034) 0:00:28.744 ****** 2025-10-02 21:00:13.375044 | controller | ok: [instance] => 2025-10-02 21:00:13.375264 | controller | msg: 2025-10-02 21:00:13.375458 | controller | - 'Commit Hash: dc98a8463506ac520c469adb0ef47d0f7753905a' 2025-10-02 21:00:13.375648 | controller | - 'Distro Hash: 9d02f069373e2f7552c7b73356c279dc6478ea42' 2025-10-02 21:00:13.375802 | controller | - 'Extended Hash: ' 2025-10-02 21:00:13.375948 | controller | - 'Full Hash: dc98a8463506ac520c469adb0ef47d0f7753905a_9d02f069' 2025-10-02 21:00:13.376079 | controller | 2025-10-02 21:00:13.376229 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:13.376374 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.038) 0:00:28.783 ****** 2025-10-02 21:00:13.408268 | controller | skipping: [instance] 2025-10-02 21:00:13.408496 | controller | 2025-10-02 21:00:13.408691 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:13.408854 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.033) 0:00:28.816 ****** 2025-10-02 21:00:13.903954 | controller | changed: [instance] 2025-10-02 21:00:14.094748 | controller | 2025-10-02 21:00:14.094781 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:14.094789 | controller | Thursday 02 October 2025 21:00:13 +0000 (0:00:00.494) 0:00:29.311 ****** 2025-10-02 21:00:14.094799 | controller | ok: [instance] 2025-10-02 21:00:14.131466 | controller | 2025-10-02 21:00:14.131499 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:14.131507 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.190) 0:00:29.502 ****** 2025-10-02 21:00:14.131518 | controller | ok: [instance] 2025-10-02 21:00:14.169385 | controller | 2025-10-02 21:00:14.169410 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:14.169417 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.036) 0:00:29.539 ****** 2025-10-02 21:00:14.169428 | controller | ok: [instance] 2025-10-02 21:00:14.202490 | controller | 2025-10-02 21:00:14.202513 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:14.202520 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.037) 0:00:29.577 ****** 2025-10-02 21:00:14.202530 | controller | skipping: [instance] 2025-10-02 21:00:14.234753 | controller | 2025-10-02 21:00:14.234775 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:14.234784 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.033) 0:00:29.610 ****** 2025-10-02 21:00:14.234794 | controller | skipping: [instance] 2025-10-02 21:00:14.274557 | controller | 2025-10-02 21:00:14.274600 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:14.274611 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.032) 0:00:29.642 ****** 2025-10-02 21:00:14.274624 | controller | ok: [instance] => 2025-10-02 21:00:14.274654 | controller | msg: 2025-10-02 21:00:14.274663 | controller | - 'Commit Hash: 8515371b7cceebd4282e09f1d8f0cc842df82855' 2025-10-02 21:00:14.274670 | controller | - 'Distro Hash: a1e336c76d2cdd49a53051230126c07d71e5dd67' 2025-10-02 21:00:14.274679 | controller | - 'Extended Hash: ' 2025-10-02 21:00:14.274705 | controller | - 'Full Hash: 8515371b7cceebd4282e09f1d8f0cc842df82855_a1e336c7' 2025-10-02 21:00:14.274984 | controller | 2025-10-02 21:00:14.310520 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:14.310550 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.039) 0:00:29.682 ****** 2025-10-02 21:00:14.310563 | controller | skipping: [instance] 2025-10-02 21:00:14.807955 | controller | 2025-10-02 21:00:14.808216 | controller | TASK [dlrn_promote : Get commit.yaml file] ************************************* 2025-10-02 21:00:14.808226 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.036) 0:00:29.718 ****** 2025-10-02 21:00:14.808243 | controller | changed: [instance] 2025-10-02 21:00:15.001359 | controller | 2025-10-02 21:00:15.001404 | controller | TASK [dlrn_promote : Load data from commit.yaml file] ************************** 2025-10-02 21:00:15.001414 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.497) 0:00:30.215 ****** 2025-10-02 21:00:15.001427 | controller | ok: [instance] 2025-10-02 21:00:15.042686 | controller | 2025-10-02 21:00:15.042728 | controller | TASK [dlrn_promote : Filter slurp data from commit.yaml] *********************** 2025-10-02 21:00:15.042737 | controller | Thursday 02 October 2025 21:00:14 +0000 (0:00:00.193) 0:00:30.409 ****** 2025-10-02 21:00:15.042749 | controller | ok: [instance] 2025-10-02 21:00:15.081302 | controller | 2025-10-02 21:00:15.081343 | controller | TASK [dlrn_promote : Get individual commit/distro hashes] ********************** 2025-10-02 21:00:15.081360 | controller | Thursday 02 October 2025 21:00:15 +0000 (0:00:00.041) 0:00:30.450 ****** 2025-10-02 21:00:15.081372 | controller | ok: [instance] 2025-10-02 21:00:15.114519 | controller | 2025-10-02 21:00:15.114543 | controller | TASK [dlrn_promote : Get individual extended hash - if it is not None] ********* 2025-10-02 21:00:15.114550 | controller | Thursday 02 October 2025 21:00:15 +0000 (0:00:00.038) 0:00:30.489 ****** 2025-10-02 21:00:15.114567 | controller | skipping: [instance] 2025-10-02 21:00:15.114586 | controller | 2025-10-02 21:00:15.114838 | controller | TASK [dlrn_promote : Add extended_hash to full_hash if defined] **************** 2025-10-02 21:00:15.147995 | controller | Thursday 02 October 2025 21:00:15 +0000 (0:00:00.033) 0:00:30.522 ****** 2025-10-02 21:00:15.148031 | controller | skipping: [instance] 2025-10-02 21:00:15.187473 | controller | 2025-10-02 21:00:15.187502 | controller | TASK [dlrn_promote : Print hash infos] ***************************************** 2025-10-02 21:00:15.187510 | controller | Thursday 02 October 2025 21:00:15 +0000 (0:00:00.033) 0:00:30.555 ****** 2025-10-02 21:00:15.187520 | controller | ok: [instance] => 2025-10-02 21:00:15.221810 | controller | msg: 2025-10-02 21:00:15.221840 | controller | - 'Commit Hash: 013accbfd179753bc3f0d1f4e5bed07a4fd9f771' 2025-10-02 21:00:15.221850 | controller | - 'Distro Hash: 0c88e46727170fa3619380fe22c70ce33ea3c02a' 2025-10-02 21:00:15.221857 | controller | - 'Extended Hash: ' 2025-10-02 21:00:15.221864 | controller | - 'Full Hash: 013accbfd179753bc3f0d1f4e5bed07a4fd9f771_0c88e467' 2025-10-02 21:00:15.221872 | controller | 2025-10-02 21:00:15.221879 | controller | TASK [dlrn_promote : Run promotion] ******************************************** 2025-10-02 21:00:15.221886 | controller | Thursday 02 October 2025 21:00:15 +0000 (0:00:00.038) 0:00:30.594 ****** 2025-10-02 21:00:15.221897 | controller | skipping: [instance] 2025-10-02 21:00:15.258724 | controller | 2025-10-02 21:00:15.258751 | controller | TASK [dlrn_promote : Promote hash for component line] ************************** 2025-10-02 21:00:15.258760 | controller | Thursday 02 October 2025 21:00:15 +0000 (0:00:00.034) 0:00:30.629 ****** 2025-10-02 21:00:15.258770 | controller | skipping: [instance] 2025-10-02 21:00:15.258794 | controller | 2025-10-02 21:00:15.259526 | controller | PLAY RECAP ********************************************************************* 2025-10-02 21:00:15.259582 | controller | instance : ok=134 changed=27 unreachable=0 failed=0 skipped=78 rescued=0 ignored=0 2025-10-02 21:00:15.259590 | controller | 2025-10-02 21:00:15.259597 | controller | Thursday 02 October 2025 21:00:15 +0000 (0:00:00.037) 0:00:30.666 ****** 2025-10-02 21:00:15.259602 | controller | =============================================================================== 2025-10-02 21:00:15.259610 | controller | repo_setup : Remove existing repos from /etc/yum.repos.d directory ------ 1.59s 2025-10-02 21:00:15.259630 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 1.52s 2025-10-02 21:00:15.260496 | controller | repo_setup : Make sure git-core package is installed -------------------- 1.39s 2025-10-02 21:00:15.260518 | controller | repo_setup : Initialize python venv and install requirements ------------ 1.35s 2025-10-02 21:00:15.260524 | controller | Gathering Facts --------------------------------------------------------- 0.85s 2025-10-02 21:00:15.260529 | controller | repo_setup : Run repo-setup --------------------------------------------- 0.84s 2025-10-02 21:00:15.260535 | controller | repo_setup : Ensure directories are present ----------------------------- 0.69s 2025-10-02 21:00:15.260540 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.63s 2025-10-02 21:00:15.260545 | controller | repo_setup : Get repo-setup repository ---------------------------------- 0.62s 2025-10-02 21:00:15.260550 | controller | repo_setup : Dump full hash in delorean.repo.md5 file ------------------- 0.57s 2025-10-02 21:00:15.260557 | controller | repo_setup : Run repo-setup-get-hash ------------------------------------ 0.56s 2025-10-02 21:00:15.261348 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.51s 2025-10-02 21:00:15.334058 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.50s 2025-10-02 21:00:15.334081 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.50s 2025-10-02 21:00:15.334093 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.50s 2025-10-02 21:00:15.334099 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.49s 2025-10-02 21:00:15.334105 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.49s 2025-10-02 21:00:15.334110 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.49s 2025-10-02 21:00:15.334115 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.49s 2025-10-02 21:00:15.334120 | controller | dlrn_promote : Get commit.yaml file ------------------------------------- 0.49s 2025-10-02 21:00:15.334129 | controller | INFO Running default > cleanup 2025-10-02 21:00:15.334590 | controller | WARNING Skipping, cleanup playbook not configured. 2025-10-02 21:00:15.335215 | controller | INFO Writing /tmp/report.html report. 2025-10-02 21:00:15.443053 | controller | changed 2025-10-02 21:00:15.498261 | 2025-10-02 21:00:15.498339 | PLAY RECAP 2025-10-02 21:00:15.498384 | controller | ok: 2 changed: 1 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2025-10-02 21:00:15.498408 | 2025-10-02 21:00:15.573504 | RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/molecule-test.yml@main] 2025-10-02 21:00:15.574428 | POST-RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/collect-logs.yml@main] 2025-10-02 21:00:16.149422 | 2025-10-02 21:00:16.149528 | PLAY [Run ci/playbooks/collect-logs.yml] 2025-10-02 21:00:16.170122 | 2025-10-02 21:00:16.170214 | TASK [Filter out host if needed] 2025-10-02 21:00:16.179154 | controller | skipping: end_host conditional evaluated to False, continuing execution for controller 2025-10-02 21:00:16.183770 | 2025-10-02 21:00:16.183841 | TASK [Ensure file is present] 2025-10-02 21:00:16.552870 | controller | ok 2025-10-02 21:00:16.561274 | 2025-10-02 21:00:16.561359 | TASK [Manage molecule report file] 2025-10-02 21:00:17.103658 | controller | changed 2025-10-02 21:00:17.109817 | 2025-10-02 21:00:17.109897 | TASK [Check if we get ci-framework-data basedir] 2025-10-02 21:00:17.301874 | controller | ok 2025-10-02 21:00:17.307468 | 2025-10-02 21:00:17.307546 | TASK [Create ci-framework-data log directory for zuul] 2025-10-02 21:00:17.661613 | controller | changed 2025-10-02 21:00:17.666963 | 2025-10-02 21:00:17.667047 | TASK [Copy ci-framework interesting files] 2025-10-02 21:00:17.916115 | controller | cp: cannot stat '/home/zuul/ci-framework-data/tests': No such file or directory 2025-10-02 21:00:18.238281 | controller | changed 2025-10-02 21:00:18.243933 | 2025-10-02 21:00:18.244019 | TASK [Get SELinux listing] 2025-10-02 21:00:18.774249 | controller | changed 2025-10-02 21:00:18.780348 | 2025-10-02 21:00:18.780434 | TASK [Generate log index] 2025-10-02 21:00:19.494576 | controller | changed 2025-10-02 21:00:19.501245 | 2025-10-02 21:00:19.501359 | TASK [Get some env related data] 2025-10-02 21:00:20.054125 | controller | /home/zuul/.local/bin/ansible 2025-10-02 21:00:21.047196 | controller | changed 2025-10-02 21:00:21.053076 | 2025-10-02 21:00:21.053174 | TASK [Generate list of logs to collect in home directory] 2025-10-02 21:00:21.345881 | controller | ok: All paths examined 2025-10-02 21:00:21.352070 | 2025-10-02 21:00:21.352152 | LOOP [Copy logs from home directory] 2025-10-02 21:00:21.670789 | controller | changed: 2025-10-02 21:00:21.670926 | controller | { 2025-10-02 21:00:21.670961 | controller | "atime": 1759438606.1886299, 2025-10-02 21:00:21.670998 | controller | "ctime": 1759438623.0707645, 2025-10-02 21:00:21.671018 | controller | "dev": 64513, 2025-10-02 21:00:21.671036 | controller | "gid": 1000, 2025-10-02 21:00:21.671053 | controller | "gr_name": "zuul", 2025-10-02 21:00:21.671071 | controller | "inode": 4448806, 2025-10-02 21:00:21.671087 | controller | "isblk": false, 2025-10-02 21:00:21.671104 | controller | "ischr": false, 2025-10-02 21:00:21.671120 | controller | "isdir": false, 2025-10-02 21:00:21.671136 | controller | "isfifo": false, 2025-10-02 21:00:21.671152 | controller | "isgid": false, 2025-10-02 21:00:21.671167 | controller | "islnk": false, 2025-10-02 21:00:21.671183 | controller | "isreg": true, 2025-10-02 21:00:21.671198 | controller | "issock": false, 2025-10-02 21:00:21.671214 | controller | "isuid": false, 2025-10-02 21:00:21.671230 | controller | "mode": "0644", 2025-10-02 21:00:21.671245 | controller | "mtime": 1759438623.0707645, 2025-10-02 21:00:21.671261 | controller | "nlink": 1, 2025-10-02 21:00:21.671276 | controller | "path": "/home/zuul/ansible.log", 2025-10-02 21:00:21.671294 | controller | "pw_name": "zuul", 2025-10-02 21:00:21.671311 | controller | "rgrp": true, 2025-10-02 21:00:21.671328 | controller | "roth": true, 2025-10-02 21:00:21.671343 | controller | "rusr": true, 2025-10-02 21:00:21.671359 | controller | "size": 6749, 2025-10-02 21:00:21.671374 | controller | "uid": 1000, 2025-10-02 21:00:21.671390 | controller | "wgrp": false, 2025-10-02 21:00:21.671406 | controller | "woth": false, 2025-10-02 21:00:21.671424 | controller | "wusr": true, 2025-10-02 21:00:21.671441 | controller | "xgrp": false, 2025-10-02 21:00:21.671457 | controller | "xoth": false, 2025-10-02 21:00:21.671472 | controller | "xusr": false 2025-10-02 21:00:21.671487 | controller | } 2025-10-02 21:00:21.685538 | 2025-10-02 21:00:21.685863 | TASK [Copy crio stats log file] 2025-10-02 21:00:21.699335 | controller | skipping: Conditional result was False 2025-10-02 21:00:21.705350 | 2025-10-02 21:00:21.705425 | TASK [Get SELinux related data] 2025-10-02 21:00:21.914452 | controller | 2025-10-02 21:00:22.232237 | controller | ERROR 2025-10-02 21:00:22.232402 | controller | { 2025-10-02 21:00:22.232442 | controller | "delta": "0:00:00.012017", 2025-10-02 21:00:22.232465 | controller | "end": "2025-10-02 21:00:21.918104", 2025-10-02 21:00:22.232484 | controller | "msg": "non-zero return code", 2025-10-02 21:00:22.232500 | controller | "rc": 1, 2025-10-02 21:00:22.232516 | controller | "start": "2025-10-02 21:00:21.906087" 2025-10-02 21:00:22.232531 | controller | } 2025-10-02 21:00:22.232554 | controller | ERROR: Ignoring Errors 2025-10-02 21:00:22.238156 | 2025-10-02 21:00:22.238227 | TASK [Create system configuration directory] 2025-10-02 21:00:22.422371 | controller | changed 2025-10-02 21:00:22.427220 | 2025-10-02 21:00:22.427294 | TASK [Get some of the system configurations] 2025-10-02 21:00:22.951254 | controller | changed 2025-10-02 21:00:22.957862 | 2025-10-02 21:00:22.957962 | TASK [Copy generated documentation if available] 2025-10-02 21:00:22.971879 | controller | skipping: Conditional result was False 2025-10-02 21:00:22.981279 | 2025-10-02 21:00:22.981390 | TASK [Copy generated AsciiDoc documentation if available] 2025-10-02 21:00:23.010936 | controller | skipping: Conditional result was False 2025-10-02 21:00:23.017232 | 2025-10-02 21:00:23.017312 | TASK [Compress logs bigger than 2MB] 2025-10-02 21:00:23.546245 | controller | changed 2025-10-02 21:00:23.559898 | 2025-10-02 21:00:23.565296 | TASK [Copy files from workspace on node] 2025-10-02 21:00:23.583877 | controller | ok 2025-10-02 21:00:23.615515 | 2025-10-02 21:00:23.615631 | TASK [fetch-output : Set log path for multiple nodes] 2025-10-02 21:00:23.640269 | controller | skipping: Conditional result was False 2025-10-02 21:00:23.646424 | 2025-10-02 21:00:23.646501 | TASK [fetch-output : Set log path for single node] 2025-10-02 21:00:23.675580 | controller | ok 2025-10-02 21:00:23.681798 | 2025-10-02 21:00:23.681875 | LOOP [fetch-output : Ensure local output dirs] 2025-10-02 21:00:23.921722 | controller -> localhost | ok: "/var/lib/zuul/builds/91035510de66489390b166f373d13924/work/logs" 2025-10-02 21:00:23.921989 | controller -> localhost | changed: All items complete 2025-10-02 21:00:23.922027 | 2025-10-02 21:00:24.127653 | controller -> localhost | changed: "/var/lib/zuul/builds/91035510de66489390b166f373d13924/work/artifacts" 2025-10-02 21:00:24.368884 | controller -> localhost | changed: "/var/lib/zuul/builds/91035510de66489390b166f373d13924/work/docs" 2025-10-02 21:00:24.386811 | 2025-10-02 21:00:24.386937 | LOOP [fetch-output : Collect logs, artifacts and docs] 2025-10-02 21:00:24.956893 | controller | changed: 2025-10-02 21:00:24.957110 | controller | .d..t...... ./ 2025-10-02 21:00:24.957145 | controller | >f+++++++++ README.html 2025-10-02 21:00:24.957169 | controller | >f+++++++++ ansible-execution.log 2025-10-02 21:00:24.957192 | controller | >f+++++++++ ansible.log 2025-10-02 21:00:24.957211 | controller | >f+++++++++ dmesg.log 2025-10-02 21:00:24.957230 | controller | >f+++++++++ installed-pkgs.log 2025-10-02 21:00:24.957253 | controller | >f+++++++++ python.log 2025-10-02 21:00:24.957275 | controller | >f+++++++++ registries.conf 2025-10-02 21:00:24.957294 | controller | >f+++++++++ report.html 2025-10-02 21:00:24.957314 | controller | >f+++++++++ selinux-denials.log 2025-10-02 21:00:24.957333 | controller | >f+++++++++ selinux-listing.log 2025-10-02 21:00:24.957350 | controller | cd+++++++++ ci-framework-data/ 2025-10-02 21:00:24.957367 | controller | cd+++++++++ ci-framework-data/artifacts/ 2025-10-02 21:00:24.957384 | controller | >f+++++++++ ci-framework-data/artifacts/zuul_inventory.yml 2025-10-02 21:00:24.957402 | controller | cd+++++++++ ci-framework-data/artifacts/parameters/ 2025-10-02 21:00:24.957420 | controller | >f+++++++++ ci-framework-data/artifacts/parameters/zuul-params.yml 2025-10-02 21:00:24.957438 | controller | cd+++++++++ ci-framework-data/artifacts/repositories/ 2025-10-02 21:00:24.957456 | controller | >f+++++++++ ci-framework-data/artifacts/repositories/delorean-antelope-testing.repo 2025-10-02 21:00:24.957475 | controller | >f+++++++++ ci-framework-data/artifacts/repositories/delorean.repo 2025-10-02 21:00:24.957494 | controller | >f+++++++++ ci-framework-data/artifacts/repositories/delorean.repo.md5 2025-10-02 21:00:24.957512 | controller | >f+++++++++ ci-framework-data/artifacts/repositories/repo-setup-centos-appstream.repo 2025-10-02 21:00:24.957529 | controller | >f+++++++++ ci-framework-data/artifacts/repositories/repo-setup-centos-baseos.repo 2025-10-02 21:00:24.957546 | controller | >f+++++++++ ci-framework-data/artifacts/repositories/repo-setup-centos-highavailability.repo 2025-10-02 21:00:24.957564 | controller | >f+++++++++ ci-framework-data/artifacts/repositories/repo-setup-centos-powertools.repo 2025-10-02 21:00:24.957581 | controller | cd+++++++++ ci-framework-data/logs/ 2025-10-02 21:00:24.957599 | controller | >f+++++++++ ci-framework-data/logs/molecule-execution.log 2025-10-02 21:00:24.957616 | controller | cd+++++++++ registries.conf.d/ 2025-10-02 21:00:24.957633 | controller | >f+++++++++ registries.conf.d/000-shortnames.conf 2025-10-02 21:00:24.957650 | controller | cd+++++++++ system-config/ 2025-10-02 21:00:24.957667 | controller | cd+++++++++ system-config/libvirt/ 2025-10-02 21:00:24.957683 | controller | >f+++++++++ system-config/libvirt/libvirt-admin.conf 2025-10-02 21:00:24.957700 | controller | >f+++++++++ system-config/libvirt/libvirt.conf 2025-10-02 21:00:25.330306 | controller | changed: .d..t...... ./ 2025-10-02 21:00:25.699221 | controller | changed: .d..t...... ./ 2025-10-02 21:00:25.717017 | 2025-10-02 21:00:25.717212 | TASK [Return artifact to Zuul] 2025-10-02 21:00:25.746545 | controller | ok 2025-10-02 21:00:25.765856 | 2025-10-02 21:00:25.765934 | PLAY [Run ci/playbooks/collect-logs.yml on CRC host] 2025-10-02 21:00:25.766050 | 2025-10-02 21:00:25.766079 | PLAY RECAP 2025-10-02 21:00:25.766118 | controller | ok: 18 changed: 13 unreachable: 0 failed: 0 skipped: 4 rescued: 0 ignored: 1 2025-10-02 21:00:25.766141 | 2025-10-02 21:00:25.839360 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/collect-logs.yml@main] 2025-10-02 21:00:25.840156 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master] 2025-10-02 21:00:26.467161 | 2025-10-02 21:00:26.467326 | PLAY [all] 2025-10-02 21:00:26.485958 | 2025-10-02 21:00:26.486045 | TASK [include_role : fetch-output] 2025-10-02 21:00:26.535643 | controller | ok 2025-10-02 21:00:26.567368 | 2025-10-02 21:00:26.567477 | TASK [fetch-output : Set log path for multiple nodes] 2025-10-02 21:00:26.612580 | controller | skipping: Conditional result was False 2025-10-02 21:00:26.618757 | 2025-10-02 21:00:26.618845 | TASK [fetch-output : Set log path for single node] 2025-10-02 21:00:26.658881 | controller | ok 2025-10-02 21:00:26.663762 | 2025-10-02 21:00:26.663834 | LOOP [fetch-output : Ensure local output dirs] 2025-10-02 21:00:27.071133 | controller -> localhost | ok: "/var/lib/zuul/builds/91035510de66489390b166f373d13924/work/logs" 2025-10-02 21:00:27.403105 | controller -> localhost | ok: "/var/lib/zuul/builds/91035510de66489390b166f373d13924/work/artifacts" 2025-10-02 21:00:27.611797 | controller -> localhost | ok: "/var/lib/zuul/builds/91035510de66489390b166f373d13924/work/docs" 2025-10-02 21:00:27.625849 | 2025-10-02 21:00:27.626023 | LOOP [fetch-output : Collect logs, artifacts and docs] 2025-10-02 21:00:28.353815 | controller | ok 2025-10-02 21:00:28.354109 | controller | ok: All items complete 2025-10-02 21:00:28.354171 | 2025-10-02 21:00:28.735839 | controller | ok 2025-10-02 21:00:29.133829 | controller | ok 2025-10-02 21:00:29.149631 | 2025-10-02 21:00:29.149744 | TASK [include_role : fetch-output-openshift] 2025-10-02 21:00:29.163536 | controller | skipping: Conditional result was False 2025-10-02 21:00:29.169654 | 2025-10-02 21:00:29.169735 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2025-10-02 21:00:29.537340 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.008834 2025-10-02 21:00:29.758135 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.015831 2025-10-02 21:00:29.792016 | 2025-10-02 21:00:29.792102 | PLAY [all] 2025-10-02 21:00:29.815928 | 2025-10-02 21:00:29.816015 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2025-10-02 21:00:30.240142 | controller | changed 2025-10-02 21:00:30.276059 | 2025-10-02 21:00:30.276148 | PLAY RECAP 2025-10-02 21:00:30.276194 | controller | ok: 5 changed: 2 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0 2025-10-02 21:00:30.276216 | 2025-10-02 21:00:30.379171 | POST-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master] 2025-10-02 21:00:30.379950 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-logs.yaml@master] 2025-10-02 21:00:30.981948 | 2025-10-02 21:00:30.982064 | PLAY [localhost] 2025-10-02 21:00:31.000735 | 2025-10-02 21:00:31.000818 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2025-10-02 21:00:31.322293 | localhost | changed 2025-10-02 21:00:31.327104 | 2025-10-02 21:00:31.327262 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2025-10-02 21:00:31.357758 | localhost | ok 2025-10-02 21:00:31.367442 | 2025-10-02 21:00:31.367519 | TASK [add-fileserver : Create SSH private key tempfile] 2025-10-02 21:00:31.693842 | localhost | changed 2025-10-02 21:00:31.699576 | 2025-10-02 21:00:31.699665 | TASK [add-fileserver : Create SSH private key from secret] 2025-10-02 21:00:32.355405 | localhost | changed 2025-10-02 21:00:32.360569 | 2025-10-02 21:00:32.360652 | TASK [add-fileserver : Add fileserver ssh key] 2025-10-02 21:00:32.702835 | localhost | Identity added: /var/lib/zuul/builds/91035510de66489390b166f373d13924/work/tmp/ansible.xim9oayo (/var/lib/zuul/builds/91035510de66489390b166f373d13924/work/tmp/ansible.xim9oayo) 2025-10-02 21:00:32.703078 | localhost | ok: Runtime: 0:00:00.006083 2025-10-02 21:00:32.707503 | 2025-10-02 21:00:32.707577 | TASK [add-fileserver : Remove SSH private key from disk] 2025-10-02 21:00:32.938250 | localhost | ok: Runtime: 0:00:00.004422 2025-10-02 21:00:32.943039 | 2025-10-02 21:00:32.943119 | TASK [add-fileserver : Add fileserver to inventory] 2025-10-02 21:00:32.991813 | localhost | changed 2025-10-02 21:00:32.996028 | 2025-10-02 21:00:32.996095 | TASK [add-fileserver : Add fileserver server to known hosts] 2025-10-02 21:00:33.327198 | localhost | changed 2025-10-02 21:00:33.346807 | 2025-10-02 21:00:33.346877 | PLAY [localhost] 2025-10-02 21:00:33.358183 | 2025-10-02 21:00:33.358249 | TASK [Generate bulk log download script] 2025-10-02 21:00:33.376112 | localhost | ok 2025-10-02 21:00:33.387625 | 2025-10-02 21:00:33.387696 | TASK [local-log-download : Check API endpoint is defined] 2025-10-02 21:00:33.415198 | localhost | ok: All assertions passed 2025-10-02 21:00:33.419660 | 2025-10-02 21:00:33.419727 | TASK [local-log-download : Create download script] 2025-10-02 21:00:33.810598 | localhost -> localhost | changed 2025-10-02 21:00:33.820095 | 2025-10-02 21:00:33.820186 | TASK [Register quick-download link] 2025-10-02 21:00:33.837609 | localhost | ok 2025-10-02 21:00:33.877554 | 2025-10-02 21:00:33.877645 | PLAY [logserver.rdoproject.org] 2025-10-02 21:00:33.887793 | 2025-10-02 21:00:33.887872 | TASK [Set zuul-log-path fact] 2025-10-02 21:00:33.903946 | logserver.rdoproject.org | ok 2025-10-02 21:00:33.913482 | 2025-10-02 21:00:33.913566 | TASK [set-zuul-log-path-fact : Set log path for a build] 2025-10-02 21:00:33.940199 | logserver.rdoproject.org | ok 2025-10-02 21:00:33.945657 | 2025-10-02 21:00:33.945736 | TASK [upload-logs : Create log directories] 2025-10-02 21:00:36.222493 | logserver.rdoproject.org | changed 2025-10-02 21:00:36.226063 | 2025-10-02 21:00:36.226157 | TASK [upload-logs : Ensure logs are readable before uploading] 2025-10-02 21:00:36.469638 | logserver.rdoproject.org -> localhost | ok: Runtime: 0:00:00.005234 2025-10-02 21:00:36.474550 | 2025-10-02 21:00:36.474637 | TASK [upload-logs : Upload logs to log server] 2025-10-02 21:00:38.652355 | logserver.rdoproject.org | Output suppressed because no_log was given 2025-10-02 21:00:38.656005 | 2025-10-02 21:00:38.656086 | LOOP [upload-logs : Compress console log and json output] 2025-10-02 21:00:38.706933 | logserver.rdoproject.org | skipping: Conditional result was False 2025-10-02 21:00:38.707660 | logserver.rdoproject.org | skipping: Conditional result was False 2025-10-02 21:00:38.714474 | 2025-10-02 21:00:38.714555 | LOOP [upload-logs : Upload compressed console log and json output] 2025-10-02 21:00:38.761382 | logserver.rdoproject.org | skipping: Conditional result was False 2025-10-02 21:00:38.761607 | 2025-10-02 21:00:38.762205 | logserver.rdoproject.org | skipping: Conditional result was False 2025-10-02 21:00:38.773308 | 2025-10-02 21:00:38.773382 | LOOP [upload-logs : Upload console log and json output]