2025-09-08 03:00:13.927073 | Job console starting
2025-09-08 03:00:13.942908 | Updating git repos
2025-09-08 03:00:14.007867 | Cloning repos into workspace
2025-09-08 03:00:14.050229 | Restoring repo states
2025-09-08 03:00:14.067813 | Merging changes
2025-09-08 03:00:14.067834 | Checking out repos
2025-09-08 03:00:14.172398 | Preparing playbooks
2025-09-08 03:00:15.192170 | Running Ansible setup
2025-09-08 03:00:22.828750 | PRE-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main]
2025-09-08 03:00:24.431998 | 
2025-09-08 03:00:24.432110 | PLAY [Base pre]
2025-09-08 03:00:24.466587 | 
2025-09-08 03:00:24.466983 | TASK [Setup log path fact]
2025-09-08 03:00:24.515790 | debian-bookworm | ok
2025-09-08 03:00:24.534229 | 
2025-09-08 03:00:24.534366 | TASK [set-zuul-log-path-fact : Set log path for a build]
2025-09-08 03:00:24.604861 | debian-bookworm | ok
2025-09-08 03:00:24.617666 | 
2025-09-08 03:00:24.617775 | TASK [emit-job-header : Print job information]
2025-09-08 03:00:24.807409 | # Job Information
2025-09-08 03:00:24.807589 | Ansible Version: 2.16.14
2025-09-08 03:00:24.807622 | Job: python-black
2025-09-08 03:00:24.807652 | Pipeline: periodic-daily
2025-09-08 03:00:24.807674 | Executor: 521e9411259a
2025-09-08 03:00:24.807691 | Triggered by: https://github.com/osism/cinder-driver-dm-clone
2025-09-08 03:00:24.807708 | Event ID: 8a31b62666eb4e8e84424c609f566672
2025-09-08 03:00:24.812958 | 
2025-09-08 03:00:24.813103 | LOOP [emit-job-header : Print node information]
2025-09-08 03:00:25.007166 | debian-bookworm | ok:
2025-09-08 03:00:25.007370 | debian-bookworm | # Node Information
2025-09-08 03:00:25.007406 | debian-bookworm | Inventory Hostname: debian-bookworm
2025-09-08 03:00:25.007428 | debian-bookworm | Hostname: debian
2025-09-08 03:00:25.007446 | debian-bookworm | Username: zuul
2025-09-08 03:00:25.007464 | debian-bookworm | Distro: Debian 12.12
2025-09-08 03:00:25.007483 | debian-bookworm | Provider: regiocloud-a
2025-09-08 03:00:25.007501 | debian-bookworm | Region:
2025-09-08 03:00:25.007518 | debian-bookworm | Label: debian-bookworm
2025-09-08 03:00:25.007534 | debian-bookworm | Product Name: OpenStack Nova
2025-09-08 03:00:25.007550 | debian-bookworm | Interface IP: 2a13:1a81:8000:3124:f816:3eff:fe3d:fb4b
2025-09-08 03:00:25.021638 | 
2025-09-08 03:00:25.021739 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2025-09-08 03:00:26.003112 | debian-bookworm -> localhost | changed
2025-09-08 03:00:26.016755 | 
2025-09-08 03:00:26.016851 | TASK [log-inventory : Copy ansible inventory to logs dir]
2025-09-08 03:00:28.270924 | debian-bookworm -> localhost | changed
2025-09-08 03:00:28.282092 | 
2025-09-08 03:00:28.282181 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2025-09-08 03:00:28.919380 | debian-bookworm -> localhost | ok
2025-09-08 03:00:28.924638 | 
2025-09-08 03:00:28.924754 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2025-09-08 03:00:28.961632 | debian-bookworm | ok
2025-09-08 03:00:28.981386 | debian-bookworm | included: /var/lib/zuul/builds/1ac7447c40194cfa91510bd2e7bdb39c/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2025-09-08 03:00:28.999629 | 
2025-09-08 03:00:28.999718 | TASK [add-build-sshkey : Create Temp SSH key]
2025-09-08 03:00:30.470620 | debian-bookworm -> localhost | Generating public/private rsa key pair.
2025-09-08 03:00:30.470805 | debian-bookworm -> localhost | Your identification has been saved in /var/lib/zuul/builds/1ac7447c40194cfa91510bd2e7bdb39c/work/1ac7447c40194cfa91510bd2e7bdb39c_id_rsa
2025-09-08 03:00:30.470885 | debian-bookworm -> localhost | Your public key has been saved in /var/lib/zuul/builds/1ac7447c40194cfa91510bd2e7bdb39c/work/1ac7447c40194cfa91510bd2e7bdb39c_id_rsa.pub
2025-09-08 03:00:30.470912 | debian-bookworm -> localhost | The key fingerprint is:
2025-09-08 03:00:30.470932 | debian-bookworm -> localhost | SHA256:3Ha4ChWFH5bEhEeeZIZK1whu9Q9Pno/BiyIygChJnMU zuul-build-sshkey
2025-09-08 03:00:30.470951 | debian-bookworm -> localhost | The key's randomart image is:
2025-09-08 03:00:30.470978 | debian-bookworm -> localhost | +---[RSA 3072]----+
2025-09-08 03:00:30.470996 | debian-bookworm -> localhost | |  ..  ...@O.     |
2025-09-08 03:00:30.471015 | debian-bookworm -> localhost | |. oE ...*BB.     |
2025-09-08 03:00:30.471033 | debian-bookworm -> localhost | | +   .oo.+=..    |
2025-09-08 03:00:30.471049 | debian-bookworm -> localhost | |oo   ... o.O .   |
2025-09-08 03:00:30.471066 | debian-bookworm -> localhost | |= .     S + O    |
2025-09-08 03:00:30.471086 | debian-bookworm -> localhost | |.  .   . . + =   |
2025-09-08 03:00:30.471103 | debian-bookworm -> localhost | |    o o . o o .  |
2025-09-08 03:00:30.471119 | debian-bookworm -> localhost | |     o o o       |
2025-09-08 03:00:30.471136 | debian-bookworm -> localhost | |        .        |
2025-09-08 03:00:30.471153 | debian-bookworm -> localhost | +----[SHA256]-----+
2025-09-08 03:00:30.471196 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.738754
2025-09-08 03:00:30.476542 | 
2025-09-08 03:00:30.476619 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2025-09-08 03:00:30.492722 | debian-bookworm | ok
2025-09-08 03:00:30.502183 | debian-bookworm | included: /var/lib/zuul/builds/1ac7447c40194cfa91510bd2e7bdb39c/trusted/project_1/github.com/osism/openinfra-zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2025-09-08 03:00:30.517282 | 
2025-09-08 03:00:30.517367 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2025-09-08 03:00:30.553570 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:30.563345 | 
2025-09-08 03:00:30.563440 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2025-09-08 03:00:31.232329 | debian-bookworm | changed
2025-09-08 03:00:31.236985 | 
2025-09-08 03:00:31.237064 | TASK [add-build-sshkey : Make sure user has a .ssh]
2025-09-08 03:00:31.495034 | debian-bookworm | ok
2025-09-08 03:00:31.502428 | 
2025-09-08 03:00:31.502512 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2025-09-08 03:00:32.165831 | debian-bookworm | changed
2025-09-08 03:00:32.172469 | 
2025-09-08 03:00:32.172560 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2025-09-08 03:00:32.872521 | debian-bookworm | changed
2025-09-08 03:00:32.881655 | 
2025-09-08 03:00:32.881751 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2025-09-08 03:00:32.910461 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:32.917912 | 
2025-09-08 03:00:32.918009 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2025-09-08 03:00:33.705627 | debian-bookworm -> localhost | changed
2025-09-08 03:00:33.719919 | 
2025-09-08 03:00:33.720021 | TASK [add-build-sshkey : Add back temp key]
2025-09-08 03:00:34.398142 | debian-bookworm -> localhost | Identity added: /var/lib/zuul/builds/1ac7447c40194cfa91510bd2e7bdb39c/work/1ac7447c40194cfa91510bd2e7bdb39c_id_rsa (zuul-build-sshkey)
2025-09-08 03:00:34.398401 | debian-bookworm -> localhost | ok: Runtime: 0:00:00.015383
2025-09-08 03:00:34.407019 | 
2025-09-08 03:00:34.407113 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2025-09-08 03:00:35.129672 | debian-bookworm | ok
2025-09-08 03:00:35.137182 | 
2025-09-08 03:00:35.137334 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2025-09-08 03:00:35.227024 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:35.242061 | 
2025-09-08 03:00:35.242159 | TASK [start-zuul-console : Start zuul_console daemon.]
2025-09-08 03:00:35.714093 | debian-bookworm | ok
2025-09-08 03:00:35.729834 | 
2025-09-08 03:00:35.729939 | TASK [validate-host : Define zuul_info_dir fact]
2025-09-08 03:00:35.768574 | debian-bookworm | ok
2025-09-08 03:00:35.782069 | 
2025-09-08 03:00:35.782169 | TASK [validate-host : Ensure Zuul Ansible directory exists]
2025-09-08 03:00:36.212013 | debian-bookworm -> localhost | ok
2025-09-08 03:00:36.219714 | 
2025-09-08 03:00:36.219806 | TASK [validate-host : Collect information about the host]
2025-09-08 03:00:38.109360 | debian-bookworm | ok
2025-09-08 03:00:38.120095 | 
2025-09-08 03:00:38.120190 | TASK [validate-host : Sanitize hostname]
2025-09-08 03:00:38.268698 | debian-bookworm | ok
2025-09-08 03:00:38.297786 | 
2025-09-08 03:00:38.297883 | TASK [validate-host : Write out all ansible variables/facts known for each host]
2025-09-08 03:00:39.573450 | debian-bookworm -> localhost | changed
2025-09-08 03:00:39.584279 | 
2025-09-08 03:00:39.584387 | TASK [validate-host : Collect information about zuul worker]
2025-09-08 03:00:40.195921 | debian-bookworm | ok
2025-09-08 03:00:40.201688 | 
2025-09-08 03:00:40.201774 | TASK [validate-host : Write out all zuul information for each host]
2025-09-08 03:00:41.401615 | debian-bookworm -> localhost | changed
2025-09-08 03:00:41.409405 | 
2025-09-08 03:00:41.409485 | TASK [prepare-workspace-log : Start zuul_console daemon.]
2025-09-08 03:00:41.697782 | debian-bookworm | ok
2025-09-08 03:00:41.702404 | 
2025-09-08 03:00:41.702485 | TASK [prepare-workspace-log : Synchronize src repos to workspace directory.]
2025-09-08 03:00:42.871487 | debian-bookworm | changed:
2025-09-08 03:00:42.871638 | debian-bookworm | cd+++++++++ src/
2025-09-08 03:00:42.871666 | debian-bookworm | cd+++++++++ src/github.com/
2025-09-08 03:00:42.871687 | debian-bookworm | cd+++++++++ src/github.com/osism/
2025-09-08 03:00:42.871704 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/
2025-09-08 03:00:42.871721 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.flake8
2025-09-08 03:00:42.871738 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.zuul.yaml
2025-09-08 03:00:42.871754 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/LICENSE
2025-09-08 03:00:42.871770 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/README.md
2025-09-08 03:00:42.871786 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/
2025-09-08 03:00:42.871801 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/HEAD
2025-09-08 03:00:42.871817 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/ORIG_HEAD
2025-09-08 03:00:42.871832 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/config
2025-09-08 03:00:42.871847 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/config.worktree
2025-09-08 03:00:42.871862 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/description
2025-09-08 03:00:42.871878 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/index
2025-09-08 03:00:42.871893 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/packed-refs
2025-09-08 03:00:42.871907 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/branches/
2025-09-08 03:00:42.871922 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/
2025-09-08 03:00:42.871937 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/applypatch-msg.sample
2025-09-08 03:00:42.871951 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/commit-msg.sample
2025-09-08 03:00:42.871966 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/fsmonitor-watchman.sample
2025-09-08 03:00:42.871980 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/post-update.sample
2025-09-08 03:00:42.871995 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-applypatch.sample
2025-09-08 03:00:42.872009 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-commit.sample
2025-09-08 03:00:42.872023 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-merge-commit.sample
2025-09-08 03:00:42.872038 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-push.sample
2025-09-08 03:00:42.872062 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-rebase.sample
2025-09-08 03:00:42.872079 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/pre-receive.sample
2025-09-08 03:00:42.872095 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/prepare-commit-msg.sample
2025-09-08 03:00:42.872110 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/push-to-checkout.sample
2025-09-08 03:00:42.872125 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/hooks/update.sample
2025-09-08 03:00:42.872139 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/info/
2025-09-08 03:00:42.872154 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/info/exclude
2025-09-08 03:00:42.872168 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/
2025-09-08 03:00:42.872182 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/HEAD
2025-09-08 03:00:42.872196 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/
2025-09-08 03:00:42.872211 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/heads/
2025-09-08 03:00:42.872225 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/heads/main
2025-09-08 03:00:42.872239 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/remotes/
2025-09-08 03:00:42.872254 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/remotes/origin/
2025-09-08 03:00:42.872268 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/logs/refs/remotes/origin/HEAD
2025-09-08 03:00:42.872283 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/
2025-09-08 03:00:42.872298 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/info/
2025-09-08 03:00:42.872323 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/pack/
2025-09-08 03:00:42.872338 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/pack/pack-fa180ec00da9f01d74bd13ec6c07652e2e797814.idx
2025-09-08 03:00:42.872353 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/objects/pack/pack-fa180ec00da9f01d74bd13ec6c07652e2e797814.pack
2025-09-08 03:00:42.872368 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/.git/refs/
2025-09-08 03:00:42.872384 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/
2025-09-08 03:00:42.872399 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/
2025-09-08 03:00:42.872414 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/
2025-09-08 03:00:42.872428 | debian-bookworm | cd+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/
2025-09-08 03:00:42.872443 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/__init__.py
2025-09-08 03:00:42.872459 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/dmsetup.py
2025-09-08 03:00:42.872475 | debian-bookworm | <f+++++++++ src/github.com/osism/cinder-driver-dm-clone/cinder/volume/drivers/dmclone/driver.py
2025-09-08 03:00:42.877798 | 
2025-09-08 03:00:42.877864 | PLAY RECAP
2025-09-08 03:00:42.877902 | debian-bookworm | ok: 26 changed: 11 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0
2025-09-08 03:00:42.877922 | 
2025-09-08 03:00:43.084394 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/pre.yaml@main]
2025-09-08 03:00:43.085596 | RUN START: [untrusted : github.com/osism/zuul-jobs/playbooks/python-black/run.yml@main]
2025-09-08 03:00:44.041494 | 
2025-09-08 03:00:44.041615 | PLAY [Install Black and format code]
2025-09-08 03:00:44.055150 | 
2025-09-08 03:00:44.055257 | LOOP [Install python]
2025-09-08 03:00:44.078142 | debian-bookworm | ok: "ensure-python"
2025-09-08 03:00:44.083097 | debian-bookworm | ok: "ensure-pip"
2025-09-08 03:00:44.126078 | 
2025-09-08 03:00:44.126211 | TASK [ensure-python : Validate python_version value]
2025-09-08 03:00:44.149274 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.155035 | 
2025-09-08 03:00:44.155130 | TASK [ensure-python : Install specified version of python interpreter and development files (DEB)]
2025-09-08 03:00:44.177929 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.183238 | 
2025-09-08 03:00:44.183357 | TASK [ensure-python : Pull in venv package]
2025-09-08 03:00:44.205890 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.211586 | 
2025-09-08 03:00:44.211694 | TASK [ensure-python : Set default RPM package name]
2025-09-08 03:00:44.234244 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.239552 | 
2025-09-08 03:00:44.239641 | TASK [ensure-python : Set RPM package name for CentOS/RHEL 9 and Python 3.9]
2025-09-08 03:00:44.262519 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.280582 | 
2025-09-08 03:00:44.280739 | TASK [ensure-python : Install RPM package]
2025-09-08 03:00:44.304704 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.314256 | 
2025-09-08 03:00:44.314431 | TASK [ensure-python : Install python using pyenv]
2025-09-08 03:00:44.328708 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.335700 | 
2025-09-08 03:00:44.335795 | TASK [ensure-python : Activate python using stow]
2025-09-08 03:00:44.358505 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:44.375343 | 
2025-09-08 03:00:44.375456 | TASK [ensure-pip : Check if pip is installed]
2025-09-08 03:00:44.905402 | debian-bookworm | ok: Runtime: 0:00:00.008245
2025-09-08 03:00:44.911841 | 
2025-09-08 03:00:44.911941 | LOOP [ensure-pip : Install pip from packages]
2025-09-08 03:00:44.958075 | debian-bookworm | ok: "/var/lib/zuul/builds/1ac7447c40194cfa91510bd2e7bdb39c/untrusted/project_2/github.com/osism/openinfra-zuul-jobs/roles/ensure-pip/tasks/Debian.yaml"
2025-09-08 03:00:44.958280 | debian-bookworm | ok: All items complete
2025-09-08 03:00:44.958376 | 
2025-09-08 03:00:44.996772 | debian-bookworm | included: /var/lib/zuul/builds/1ac7447c40194cfa91510bd2e7bdb39c/untrusted/project_2/github.com/osism/openinfra-zuul-jobs/roles/ensure-pip/tasks/Debian.yaml
2025-09-08 03:00:45.006535 | 
2025-09-08 03:00:45.006632 | TASK [ensure-pip : Update package lists]
2025-09-08 03:00:49.515023 | debian-bookworm | changed
2025-09-08 03:00:49.520743 | 
2025-09-08 03:00:49.520862 | TASK [ensure-pip : Install Python 3 pip]
2025-09-08 03:00:54.761002 | debian-bookworm | changed
2025-09-08 03:00:54.770280 | 
2025-09-08 03:00:54.770469 | TASK [ensure-pip : Install Python 2 pip]
2025-09-08 03:00:54.816181 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:54.823599 | 
2025-09-08 03:00:54.823732 | TASK [ensure-pip : Ensure setuptools]
2025-09-08 03:00:54.847296 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:54.855230 | 
2025-09-08 03:00:54.855554 | TASK [ensure-pip : Check for ensurepip module]
2025-09-08 03:00:55.171514 | debian-bookworm | usage: python -m ensurepip [-h] [--version] [-v] [-U] [--user] [--root ROOT]
2025-09-08 03:00:55.171724 | debian-bookworm |                            [--altinstall] [--default-pip]
2025-09-08 03:00:55.171749 | debian-bookworm |
2025-09-08 03:00:55.171765 | debian-bookworm | options:
2025-09-08 03:00:55.171784 | debian-bookworm |   -h, --help     show this help message and exit
2025-09-08 03:00:55.171805 | debian-bookworm |   --version      Show the version of pip that is bundled with this Python.
2025-09-08 03:00:55.171820 | debian-bookworm |   -v, --verbose  Give more output. Option is additive, and can be used up to 3
2025-09-08 03:00:55.171865 | debian-bookworm |                  times.
2025-09-08 03:00:55.171892 | debian-bookworm |   -U, --upgrade  Upgrade pip and dependencies, even if already installed.
2025-09-08 03:00:55.171908 | debian-bookworm |   --user         Install using the user scheme.
2025-09-08 03:00:55.171921 | debian-bookworm |   --root ROOT    Install everything relative to this alternate root directory.
2025-09-08 03:00:55.171934 | debian-bookworm |   --altinstall   Make an alternate install, installing only the X.Y versioned
2025-09-08 03:00:55.171946 | debian-bookworm |                  scripts (Default: pipX, pipX.Y, easy_install-X.Y).
2025-09-08 03:00:55.171957 | debian-bookworm |   --default-pip  Make a default pip install, installing the unqualified pip
2025-09-08 03:00:55.171968 | debian-bookworm |                  and easy_install in addition to the versioned scripts.
2025-09-08 03:00:55.389694 | debian-bookworm | ok: Runtime: 0:00:00.063537
2025-09-08 03:00:55.402410 | 
2025-09-08 03:00:55.402591 | TASK [ensure-pip : Ensure python3-venv]
2025-09-08 03:00:55.428893 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:55.442713 | 
2025-09-08 03:00:55.442918 | TASK [ensure-pip : Install pip from source]
2025-09-08 03:00:55.468938 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:00:55.477698 | 
2025-09-08 03:00:55.477837 | TASK [ensure-pip : Probe for venv python full path]
2025-09-08 03:00:55.732384 | debian-bookworm | /usr/bin/python3
2025-09-08 03:00:56.007764 | debian-bookworm | ok: Runtime: 0:00:00.004988
2025-09-08 03:00:56.019333 | 
2025-09-08 03:00:56.019487 | TASK [ensure-pip : Set host default]
2025-09-08 03:00:56.093604 | debian-bookworm | ok
2025-09-08 03:00:56.099102 | 
2025-09-08 03:00:56.099214 | TASK [ensure-pip : Set ensure_pip_virtualenv_command]
2025-09-08 03:00:56.178075 | debian-bookworm | ok
2025-09-08 03:00:56.231335 | 
2025-09-08 03:00:56.231475 | TASK [python-black : Install black]
2025-09-08 03:01:02.536890 | debian-bookworm | changed
2025-09-08 03:01:02.551662 | 
2025-09-08 03:01:02.551811 | TASK [python-black : Format code with Black if there is nothing to exclude]
2025-09-08 03:01:03.414387 | debian-bookworm | All done! ✨ 🍰 ✨
2025-09-08 03:01:03.414503 | debian-bookworm | 3 files would be left unchanged.
2025-09-08 03:01:03.671492 | debian-bookworm | ok: Runtime: 0:00:00.424719
2025-09-08 03:01:03.677136 | 
2025-09-08 03:01:03.677249 | TASK [python-black : Format code with Black if there is an exclusion]
2025-09-08 03:01:04.218050 | debian-bookworm | skipping: Conditional result was False
2025-09-08 03:01:04.229102 | 
2025-09-08 03:01:04.229375 | PLAY RECAP
2025-09-08 03:01:04.229457 | debian-bookworm | ok: 10 changed: 6 unreachable: 0 failed: 0 skipped: 13 rescued: 0 ignored: 0
2025-09-08 03:01:04.229485 | 
2025-09-08 03:01:04.666656 | RUN END RESULT_NORMAL: [untrusted : github.com/osism/zuul-jobs/playbooks/python-black/run.yml@main]
2025-09-08 03:01:04.667503 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main]
2025-09-08 03:01:05.880122 | 
2025-09-08 03:01:05.880239 | PLAY [Base post]
2025-09-08 03:01:05.899901 | 
2025-09-08 03:01:05.900010 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2025-09-08 03:01:06.687823 | debian-bookworm | changed
2025-09-08 03:01:06.692579 | 
2025-09-08 03:01:06.692648 | PLAY RECAP
2025-09-08 03:01:06.692696 | debian-bookworm | ok: 1 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2025-09-08 03:01:06.692747 | 
2025-09-08 03:01:06.958134 | POST-RUN END RESULT_NORMAL: [trusted : github.com/osism/zuul-config/playbooks/base/post.yaml@main]
2025-09-08 03:01:06.959127 | POST-RUN START: [trusted : github.com/osism/zuul-config/playbooks/base/post-logs.yaml@main]
2025-09-08 03:01:07.663780 | 
2025-09-08 03:01:07.663897 | PLAY [Base post-logs]
2025-09-08 03:01:07.673118 | 
2025-09-08 03:01:07.673232 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2025-09-08 03:01:08.140783 | localhost | changed
2025-09-08 03:01:08.155198 | 
2025-09-08 03:01:08.155355 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2025-09-08 03:01:08.191963 | localhost | ok
2025-09-08 03:01:08.194572 | 
2025-09-08 03:01:08.194650 | TASK [Set zuul-log-path fact]
2025-09-08 03:01:08.228725 | localhost | ok
2025-09-08 03:01:08.235710 | 
2025-09-08 03:01:08.235804 | TASK [set-zuul-log-path-fact : Set log path for a build]
2025-09-08 03:01:08.280722 | localhost | ok
2025-09-08 03:01:08.283583 | 
2025-09-08 03:01:08.283746 | TASK [upload-logs : Create log directories]
2025-09-08 03:01:09.406162 | localhost | changed
2025-09-08 03:01:09.409375 | 
2025-09-08 03:01:09.409466 | TASK [upload-logs : Ensure logs are readable before uploading]
2025-09-08 03:01:10.507609 | localhost -> localhost | ok: Runtime: 0:00:00.020347
2025-09-08 03:01:10.510673 | 
2025-09-08 03:01:10.510755 | TASK [upload-logs : Upload logs to log server]
2025-09-08 03:01:11.910428 | localhost | Output suppressed because no_log was given
2025-09-08 03:01:11.912629 | 
2025-09-08 03:01:11.912710 | LOOP [upload-logs : Compress console log and json output]
2025-09-08 03:01:12.049171 | localhost | skipping: Conditional result was False
2025-09-08 03:01:12.061040 | localhost | skipping: Conditional result was False
2025-09-08 03:01:12.072233 | 
2025-09-08 03:01:12.072592 | LOOP [upload-logs : Upload compressed console log and json output]
2025-09-08 03:01:12.127022 | localhost | skipping: Conditional result was False
2025-09-08 03:01:12.127245 | 
2025-09-08 03:01:12.131723 | localhost | skipping: Conditional result was False
2025-09-08 03:01:12.140854 | 
2025-09-08 03:01:12.140946 | LOOP [upload-logs : Upload console log and json output]