test-install-deps-extra β—‹ success

⏱ Duration: 44s
⏳ Queued: 0s
πŸ“ Stage: test
πŸ–₯ Runner: linux-2
Average Duration
40s
This job: 44s
Failure Rate
2.1%
last 30 days
β–Ά

Job Execution Phases

πŸ’‘ Tip: Click on any phase bar to jump to that section in the log below

β–Ά

Job Analysis

Job Status: Passed

Status: Job passed successfully

β–Ά

Full Job Log

223 lines
Match - of 0
1 14:27:36 Running with gitlab-runner 18.5.0 (bda84871)
2 14:27:36 on gitlab-runner-linux-2-5677d87478-dtkch TC7X7l-mC, system ID: r_vzvfqLUZvzJc
3 14:27:36 feature flags: FF_USE_FASTZIP:true, FF_USE_NEW_BASH_EVAL_STRATEGY:true, FF_SCRIPT_SECTIONS:true, FF_USE_ADVANCED_POD_SPEC_CONFIGURATION:true, FF_PRINT_POD_EVENTS:true, FF_USE_DUMB_INIT_WITH_KUBERNETES_EXECUTOR:true, FF_LOG_IMAGES_CONFIGURED_FOR_JOB:true, FF_CLEAN_UP_FAILED_CACHE_EXTRACT:true, FF_TIMESTAMPS:true, FF_GIT_URLS_WITHOUT_TOKENS:true
4 14:27:36 Resolving secrets
5 14:27:36 section_start:1765290456:prepare_executor
6 14:27:36 +Preparing the "kubernetes" executor
7 14:27:36 Using Kubernetes namespace: gitlab-runner
8 14:27:36 Using Kubernetes executor with image registry.scandit.com/internal/gitlab-templates/python:84b74ce43bf4f781828bf5a8fb662404b640c5ec93aad6d8d207b534b1aa643f ...
9 14:27:36 Using attach strategy to execute scripts...
10 14:27:36 Using effective pull policy of [Always] for container init-permissions
11 14:27:36 Using effective pull policy of [Always] for container build
12 14:27:36 Using effective pull policy of [Always] for container helper
13 14:27:36 section_end:1765290456:prepare_executor
14 14:27:36 +section_start:1765290456:prepare_script
15 14:27:36 +Preparing environment
16 14:27:36 Using FF_USE_POD_ACTIVE_DEADLINE_SECONDS, the Pod activeDeadlineSeconds will be set to the job timeout: 1h0m0s...
17 14:27:36 WARNING: Advanced Pod Spec configuration enabled, merging the provided PodSpec to the generated one. This is a beta feature and is subject to change. Feedback is collected in this issue: https://gitlab.com/gitlab-org/gitlab-runner/-/issues/29659 ...
18 14:27:36 Subscribing to Kubernetes Pod events...
19 14:27:36 Type Reason Message
20 14:27:36 Normal Scheduled Successfully assigned gitlab-runner/runner-tc7x7l-mc-project-621-concurrent-4-6bdf45w7 to ci10
21 14:27:38 Normal Pulled Container image "registry.gitlab.com/gitlab-org/gitlab-runner/gitlab-runner-helper:x86_64-v18.5.0" already present on machine
22 14:27:38 Normal Created Created container: init-permissions
23 14:27:38 Normal Started Started container init-permissions
24 14:27:39 Normal Pulling Pulling image "registry.scandit.com/internal/gitlab-templates/python:84b74ce43bf4f781828bf5a8fb662404b640c5ec93aad6d8d207b534b1aa643f"
25 14:27:54 Normal Pulled Successfully pulled image "registry.scandit.com/internal/gitlab-templates/python:84b74ce43bf4f781828bf5a8fb662404b640c5ec93aad6d8d207b534b1aa643f" in 14.644s (14.644s including waiting). Image size: 506240359 bytes.
26 14:27:55 Normal Created Created container: build
27 14:27:55 Normal Started Started container build
28 14:27:55 Normal Pulled Container image "registry.gitlab.com/gitlab-org/gitlab-runner/gitlab-runner-helper:x86_64-v18.5.0" already present on machine
29 14:27:55 Normal Created Created container: helper
30 14:27:55 Normal Started Started container helper
31 14:27:58 Running on runner-tc7x7l-mc-project-621-concurrent-4-6bdf45w7 via gitlab-runner-linux-2-5677d87478-dtkch...
32 14:27:58
33 14:27:58 section_end:1765290478:prepare_script
34 14:27:58 +section_start:1765290478:get_sources
35 14:27:58 +Getting source from Git repository
36 14:27:58 Gitaly correlation ID: 01KC1R5CJN15FZ9Z1FCJVZX7QZ
37 14:27:58 Fetching changes with git depth set to 50...
38 14:27:58 Initialized empty Git repository in /build/internal/gitlab-templates/.git/
39 14:27:58 Created fresh repository.
40 14:27:59 Checking out 940006cc as detached HEAD (ref is refs/merge-requests/507/merge)...
41 14:27:59
42 14:27:59 Skipping Git submodules setup
43 14:27:59
44 14:27:59 section_end:1765290479:get_sources
45 14:27:59 +section_start:1765290479:step_script
46 14:27:59 +Executing "step_script" stage of the job script
47 14:28:00 section_start:1765290480:section_pre_build_script_0[hide_duration=true,collapsed=true] $ function cleanup {
48 14:28:00 rv=$?
49 14:28:00 if [ $rv -ne 0 ]; then
50 14:28:00 echo ""
51 14:28:00 echo " Failure Cause Analysis might help, please open this link:"
52 14:28:00 echo " https://failure-cause-analysis.zrh.int.scandit.io/analysis/projects/${CI_PROJECT_ID}/jobs/${CI_JOB_ID}"
53 14:28:00 echo ""
54 14:28:00 fi
55 14:28:00 echo ""
56 14:28:00 echo "Grafana Pod-View: https://grafana.scandit.com/d/k8s_views_pods/kubernetes-views-pods?orgId=1&refresh=1m&var-datasource=${GRAFANA_DATASOURCE}&var-host=${SC_K8S_NODE_NAME}&var-namespace=${SC_K8S_NAMESPACE}&var-pod=${HOSTNAME}&var-resolution=15&from=${__start_time}000&to=${EPOCHSECONDS}000"
57 14:28:00 echo "Grafana Node-View: https://grafana.scandit.com/d/k8s_views_nodes/kubernetes-views-nodes?orgId=1&refresh=1m&var-datasource=${GRAFANA_DATASOURCE}&var-node=${SC_K8S_NODE_NAME}&var-resolution=15s&from=${__start_time}000&to=${EPOCHSECONDS}000"
58 14:28:00 echo ""
59 14:28:00 exit $rv
60 14:28:00 }
61 14:28:00 trap cleanup EXIT
62 14:28:00 echo "INFO: This is the CI job pre_build_script"
63 14:28:00 echo "INFO: It's defined in the backend/infra/onprem/k8s repo."
64 14:28:00 echo "INFO: These additional Scandit variables are available to you:"
65 14:28:00 echo " SC_K8S_NODE_NAME: $SC_K8S_NODE_NAME"
66 14:28:00 echo " SC_K8S_IMAGE_ID: $SC_K8S_IMAGE_ID"
67 14:28:00 echo " SC_K8S_KYVERNO_PATCHES: |"
68 14:28:00 echo "$SC_K8S_KYVERNO_PATCHES" | sed 's/^/ /'
69 14:28:00 echo "cpu (r/l): ${SC_K8S_REQUESTS_CPU}/${SC_K8S_LIMITS_CPU}"
70 14:28:00 if command -v numfmt >/dev/null 2>&1; then
71 14:28:00 echo "memory (r/l): $(numfmt --to=iec --suffix=B $SC_K8S_REQUESTS_MEMORY)/$(numfmt --to=iec --suffix=B $SC_K8S_LIMITS_MEMORY)"
72 14:28:00 else
73 14:28:00 echo "memory (r/l): ${SC_K8S_REQUESTS_MEMORY}/${SC_K8S_LIMITS_MEMORY}"
74 14:28:00 fi
75 14:28:00 __start_time=${EPOCHSECONDS}
76 14:28:00 echo ""
77 14:28:00 echo "Grafana Pod-View: https://grafana.scandit.com/d/k8s_views_pods/kubernetes-views-pods?orgId=1&refresh=1m&var-datasource=${GRAFANA_DATASOURCE}&var-host=${SC_K8S_NODE_NAME}&var-namespace=${SC_K8S_NAMESPACE}&var-pod=${HOSTNAME}&var-resolution=15&from=${__start_time}000&to=now"
78 14:28:00 echo "Grafana Node-View: https://grafana.scandit.com/d/k8s_views_nodes/kubernetes-views-nodes?orgId=1&refresh=1m&var-datasource=${GRAFANA_DATASOURCE}&var-node=${SC_K8S_NODE_NAME}&var-resolution=15s&from=${__start_time}000&to=now"
79 14:28:00 echo ""
80 14:28:00 echo "Setting up credentials for Gitlab Python registries"
81 14:28:00 mkdir -p ~
82 14:28:00 echo "machine gitlab.scandit.com" > ~/.netrc
83 14:28:00 echo "login gitlab-ci-token" >> ~/.netrc
84 14:28:00 echo "password ${CI_JOB_TOKEN}" >> ~/.netrc
85 14:28:00 chmod 600 ~/.netrc
86 14:28:00 if command -v git &> /dev/null && [ "$(id -u)" -ne 0 ]; then
87 14:28:00 git config --global --add safe.directory $CI_PROJECT_DIR
88 14:28:00 fi
89 14:28:00 sleep infinity &
90 14:28:00 echo $! > ~/.bg_pid
91 14:28:00 section_end:1765290480:section_pre_build_script_0
92 14:28:00 INFO: This is the CI job pre_build_script
93 14:28:00 INFO: It's defined in the backend/infra/onprem/k8s repo.
94 14:28:00 INFO: These additional Scandit variables are available to you:
95 14:28:00 SC_K8S_NODE_NAME: ci10
96 14:28:00 SC_K8S_IMAGE_ID:
97 14:28:00 SC_K8S_KYVERNO_PATCHES: |
98 14:28:00
99 14:28:00 cpu (r/l): 1/8
100 14:28:00 memory (r/l): 1.0GB/16GB
101 14:28:00
102 14:28:00 Grafana Pod-View: https://grafana.scandit.com/d/k8s_views_pods/kubernetes-views-pods?orgId=1&refresh=1m&var-datasource=KpIiby5Vz&var-host=ci10&var-namespace=gitlab-runner&var-pod=runner-tc7x7l-mc-project-621-concurrent-4-6bdf45w7&var-resolution=15&from=1765290480000&to=now
103 14:28:00 Grafana Node-View: https://grafana.scandit.com/d/k8s_views_nodes/kubernetes-views-nodes?orgId=1&refresh=1m&var-datasource=KpIiby5Vz&var-node=ci10&var-resolution=15s&from=1765290480000&to=now
104 14:28:00
105 14:28:00 Setting up credentials for Gitlab Python registries
106 14:28:00 $ export UV_CACHE_DIR=$CACHE_DIR/.uv
107 14:28:00 $ echo "UV_CACHE_DIR $UV_CACHE_DIR"
108 14:28:00 UV_CACHE_DIR /.uv
109 14:28:00 section_start:1765290480:section_script_step_2[hide_duration=true,collapsed=true] $ export python_version=$(cat ./.python-version)
110 14:28:00 eval "$($HOME/.pyenv/bin/pyenv init -)"
111 14:28:00 echo "Activating Python $python_version"
112 14:28:00 pyenv shell $python_version || (
113 14:28:00 echo "ERROR: Installing a new Python version in container based CI jobs is no longer allowed."
114 14:28:00 echo "Please ensure the image contains a pre-installed Python ${python_version}."
115 14:28:00 exit 1
116 14:28:00 )
117 14:28:00 pyenv version
118 14:28:00 section_end:1765290480:section_script_step_2
119 14:28:00 Activating Python 3.12
120 14:28:01 3.12.2 (set by PYENV_VERSION environment variable)
121 14:28:01 section_start:1765290480:section_script_step_3[hide_duration=true,collapsed=true] $ export python_version=$(cat ./.python-version)
122 14:28:01 VENV_CACHE_PATH=${CACHE_DIR:-/cache}/venv/${CI_PROJECT_ID}/${python_version}/${CI_COMMIT_BRANCH}
123 14:28:01 mkdir -p $VENV_CACHE_PATH
124 14:28:01 # if creation of venv fails, re-run it with "--clear"
125 14:28:01 python3 -m venv $VENV_CACHE_PATH || python3 -m venv $VENV_CACHE_PATH --clear
126 14:28:01 source $VENV_CACHE_PATH/bin/activate
127 14:28:01 python3 --version
128 14:28:01 pip install --upgrade wheel uv
129 14:28:01 section_end:1765290480:section_script_step_3
130 14:28:09 Python 3.12.2
131 14:28:10 Collecting wheel
132 14:28:10 Downloading wheel-0.45.1-py3-none-any.whl.metadata (2.3 kB)
133 14:28:11 Collecting uv
134 14:28:11 Downloading uv-0.9.16-py3-none-manylinux_2_17_x86_64.manylinux2014_x86_64.whl.metadata (11 kB)
135 14:28:11 Downloading wheel-0.45.1-py3-none-any.whl (72 kB)
136 14:28:11 ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 72.5/72.5 kB 4.7 MB/s eta 0:00:00
137 14:28:11 Downloading uv-0.9.16-py3-none-manylinux_2_17_x86_64.manylinux2014_x86_64.whl (22.0 MB)
138 14:28:11 ━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━━ 22.0/22.0 MB 85.9 MB/s eta 0:00:00
139 14:28:11 Installing collected packages: wheel, uv
140 14:28:14 Successfully installed uv-0.9.16 wheel-0.45.1
141 14:28:14
142 14:28:14 [notice] A new release of pip is available: 24.0 -> 25.3
143 14:28:14 [notice] To update, run: pip install --upgrade pip
144 14:28:14 $ time uv pip install ${PIP_REQUIREMENTS:--r requirements.txt} ${PIP_ARGS}
145 14:28:14 Using Python 3.12.2 environment at: /cache/venv/621/3.12
146 14:28:14 Resolved 12 packages in 276ms
147 14:28:14 Downloading pygments (1.2MiB)
148 14:28:15 Downloaded pygments
149 14:28:15 Prepared 12 packages in 223ms
150 14:28:15 Installed 12 packages in 37ms
151 14:28:15 + certifi==2025.11.12
152 14:28:15 + charset-normalizer==3.4.4
153 14:28:15 + coverage==7.13.0
154 14:28:15 + idna==3.11
155 14:28:15 + iniconfig==2.3.0
156 14:28:15 + packaging==25.0
157 14:28:15 + pluggy==1.6.0
158 14:28:15 + pygments==2.19.2
159 14:28:15 + pytest==9.0.1
160 14:28:15 + pytest-cov==7.0.0
161 14:28:15 + requests==2.32.5
162 14:28:15 + urllib3==2.6.1
163 14:28:15
164 14:28:15 real 0m0.663s
165 14:28:15 user 0m0.201s
166 14:28:15 sys 0m0.289s
167 14:28:15 $ pyenv rehash
168 14:28:15 $ echo This is a collapsible example section
169 14:28:15 This is a collapsible example section
170 14:28:15 $ python3 -m pytest ${PYTEST_OPTS:--m "not requirements"} --cov=. --cov-report=html --cov-report=xml --cov-report=term --junitxml=${CI_LOGS}/test_report.xml .
171 14:28:16 ============================= test session starts ==============================
172 14:28:16 platform linux -- Python 3.12.2, pytest-9.0.1, pluggy-1.6.0
173 14:28:16 rootdir: /build/internal/gitlab-templates
174 14:28:16 configfile: pytest.ini
175 14:28:16 plugins: cov-7.0.0
176 14:28:16 collected 2 items / 1 deselected / 1 selected
177 14:28:16
178 14:28:16 tests/test_requirements.py . [100%]
179 14:28:16
180 14:28:16 - generated xml file: /build/internal/gitlab-templates/ci-logs/test_report.xml -
181 14:28:16 ================================ tests coverage ================================
182 14:28:16 _______________ coverage: platform linux, python 3.12.2-final-0 ________________
183 14:28:16
184 14:28:16 Name Stmts Miss Cover
185 14:28:16 ------------------------------------------------
186 14:28:16 tests/__init__.py 0 0 100%
187 14:28:16 tests/test_python.py 4 1 75%
188 14:28:16 tests/test_requirements.py 6 0 100%
189 14:28:16 tests/utils/example.py 11 10 9%
190 14:28:16 ------------------------------------------------
191 14:28:16 TOTAL 21 11 48%
192 14:28:16 Coverage HTML written to dir htmlcov
193 14:28:16 Coverage XML written to file coverage.xml
194 14:28:16 ======================= 1 passed, 1 deselected in 0.20s ========================
195 14:28:16 $ sed -i -e "s=<source>.*</source>=<source>./</source>=g" coverage.xml
196 14:28:16 $ echo Bye
197 14:28:16 Bye
198 14:28:16
199 14:28:16 Grafana Pod-View: https://grafana.scandit.com/d/k8s_views_pods/kubernetes-views-pods?orgId=1&refresh=1m&var-datasource=KpIiby5Vz&var-host=ci10&var-namespace=gitlab-runner&var-pod=runner-tc7x7l-mc-project-621-concurrent-4-6bdf45w7&var-resolution=15&from=1765290480000&to=1765290496000
200 14:28:16 Grafana Node-View: https://grafana.scandit.com/d/k8s_views_nodes/kubernetes-views-nodes?orgId=1&refresh=1m&var-datasource=KpIiby5Vz&var-node=ci10&var-resolution=15s&from=1765290480000&to=1765290496000
201 14:28:16
202 14:28:16
203 14:28:16 section_end:1765290496:step_script
204 14:28:16 +section_start:1765290496:upload_artifacts_on_success
205 14:28:16 +Uploading artifacts for successful job
206 14:28:17 Uploading artifacts...
207 14:28:17 htmlcov/: found 14 matching artifact files and directories
208 14:28:17 Uploading artifacts as "archive" to coordinator... 201 Created correlation_id=01KC1R6N5TX80SNWA2QT9CAK1X id=46308197 responseStatus=201 Created token=64_PdzwrW
209 14:28:17 Uploading artifacts...
210 14:28:17 /build/internal/gitlab-templates/ci-logs/test_report.xml: found 1 matching artifact files and directories
211 14:28:19 Uploading artifacts as "junit" to coordinator... 201 Created correlation_id=01KC1R6NH68GPTAP2FDEK8FTGF id=46308197 responseStatus=201 Created token=64_PdzwrW
212 14:28:19 Uploading artifacts...
213 14:28:19 coverage.xml: found 1 matching artifact files and directories
214 14:28:19 Uploading artifacts as "cobertura" to coordinator... 201 Created correlation_id=01KC1R6Q05TRJMK42Z3JTV8SWF id=46308197 responseStatus=201 Created token=64_PdzwrW
215 14:28:19
216 14:28:19 section_end:1765290499:upload_artifacts_on_success
217 14:28:19 +section_start:1765290499:cleanup_file_variables
218 14:28:19 +Cleaning up project directory and file based variables
219 14:28:19
220 14:28:19 section_end:1765290499:cleanup_file_variables
221 14:28:19 +
222 14:28:19 Job succeeded
223