See https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/display/redirect
Changes:
------------------------------------------ [...truncated 62.03 KiB...] 2885:C 28 Dec 2025 09:17:15.500 * Redis version=8.0.2, bits=64, commit=00000000, modified=0, pid=2885, just started 2885:C 28 Dec 2025 09:17:15.500 * Configuration loaded 2885:M 28 Dec 2025 09:17:15.501 * monotonic clock: POSIX clock_gettime 2885:M 28 Dec 2025 09:17:15.501 * Running mode=standalone, port=6379. 2885:M 28 Dec 2025 09:17:15.502 * Server initialized 2885:M 28 Dec 2025 09:17:15.502 * Ready to accept connections tcp [1;34m[testenv][pyhss] Running pyhss_hss[0m [0;94m[testenv][pyhss] + ['podman', 'exec', '-e', 'CCACHE_DIR=/home/osmocom-build/ccache/testenv', '-e', 'TESTENV_CACHE_DIR=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_cache', '-e', 'TESTENV_SRC_DIR=/home/osmocom-build/jenkins/workspace', '-e', 'TESTENV_INSTALL_DIR=/', '-e', 'TERM=dumb', '-e', 'PATH=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts/qemu:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/hss:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin', '-e', 'HOME=/home/osmocom-build', '-e', 'PYTHONUNBUFFERED=1', '-w', 'https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_hss', 'testenv-hss-pyhss-osmocom-nightly-20251228-0917-4d65f3c9-0', 'sh', '-c', 'ulimit -c unlimited; ./run_in_venv.sh pyhss_hss 2>&1 | tee https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_hss/pyhss_hss.log'][0m [1;34m[testenv][pyhss] Running pyhss_diameter[0m [0;94m[testenv][pyhss] + ['podman', 'exec', '-e', 'CCACHE_DIR=/home/osmocom-build/ccache/testenv', '-e', 'TESTENV_CACHE_DIR=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_cache', '-e', 'TESTENV_SRC_DIR=/home/osmocom-build/jenkins/workspace', '-e', 'TESTENV_INSTALL_DIR=/', '-e', 'TERM=dumb', '-e', 'PATH=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts/qemu:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/hss:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin', '-e', 'HOME=/home/osmocom-build', '-e', 'PYTHONUNBUFFERED=1', '-w', 'https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_diameter', 'testenv-hss-pyhss-osmocom-nightly-20251228-0917-4d65f3c9-0', 'sh', '-c', 'ulimit -c unlimited; cd ../pyhss_hss && ./run_in_venv.sh pyhss_diameter 2>&1 | tee https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_diameter/pyhss_diameter.log'][0m [1;34m[testenv][pyhss] Running pyhss_diameter setup script[0m [0;94m[testenv][pyhss] + ['podman', 'exec', '-e', 'CCACHE_DIR=/home/osmocom-build/ccache/testenv', '-e', 'TESTENV_CACHE_DIR=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_cache', '-e', 'TESTENV_SRC_DIR=/home/osmocom-build/jenkins/workspace', '-e', 'TESTENV_INSTALL_DIR=/', '-e', 'TERM=dumb', '-e', 'PATH=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts/qemu:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/hss:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin', '-e', 'HOME=/home/osmocom-build', '-e', 'PYTHONUNBUFFERED=1', '-t', '-w', 'https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_diameter', 'testenv-hss-pyhss-osmocom-nightly-20251228-0917-4d65f3c9-0', 'sh', '-c', './run_in_venv.sh wait_for_port.py -p 3868 -H 127.0.0.201 -P sctp'][0m [Diameter] [DEBUG] [Diameter] [startServer] SCTP Parameters: {'initialRto': 1000, 'rtoMin': 500, 'rtoMax': 5000} [Diameter] [INFO] [Diameter] [logProcessedMessages] Processed 0 inbound diameter messages in the last 3600 second(s) [Diameter] [INFO]
###### ## ## ##### ##### ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ###### ## ## ####### ##### ##### ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ##### ## ## ##### ##### ## ####
Diameter Service
[Diameter] Serving on ('127.0.0.201', 3868) [Diameter] [INFO] [Diameter] [logProcessedMessages] Processed 0 outbound in the last 3600 second(s) [Diameter] [INFO] [Diameter] New Connection from: 127.0.0.1 on port 37308 [Diameter] [INFO] [Diameter] [logActivePeers] 1 Active Peers {'127.0.0.1-37308': Peer(IpAddress='127.0.0.1', Port='37308', Hostname='', Connected=True, TransportProtocol='', PeerType='', LastConnectTimestamp='2025-12-28T09:17:16.120218+00:00', LastDisconnectTimestamp='', ReconnectionCount=0, Metadata='')} [Diameter] [DEBUG] [Diameter] [readInboundData] [a432a406-09bc-4dc7-a18d-6419428b08c3] New connection from 127.0.0.1 on port 37308 [Diameter] [DEBUG] [Diameter] [writeOutboundData] [a432a406-09bc-4dc7-a18d-6419428b08c3] writeOutboundData with host 127.0.0.1 on port 37308 [Diameter] [DEBUG] [Diameter] [writeOutboundData] [a432a406-09bc-4dc7-a18d-6419428b08c3] Waiting for messages for host 127.0.0.1 on port 37308 [HSS] [INFO]
###### ## ## ##### ##### ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ###### ## ## ####### ##### ##### ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ## ##### ## ## ##### ##### ## ####
HSS Service
[1;34m[testenv][pyhss] Running pyhss_api[0m [0;94m[testenv][pyhss] + ['podman', 'exec', '-e', 'CCACHE_DIR=/home/osmocom-build/ccache/testenv', '-e', 'TESTENV_CACHE_DIR=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_cache', '-e', 'TESTENV_SRC_DIR=/home/osmocom-build/jenkins/workspace', '-e', 'TESTENV_INSTALL_DIR=/', '-e', 'TERM=dumb', '-e', 'PATH=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts/qemu:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/hss:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin', '-e', 'HOME=/home/osmocom-build', '-e', 'PYTHONUNBUFFERED=1', '-w', 'https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_api', 'testenv-hss-pyhss-osmocom-nightly-20251228-0917-4d65f3c9-0', 'sh', '-c', 'ulimit -c unlimited; cd ../pyhss_hss && ./run_in_venv.sh pyhss_api 2>&1 | tee https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_api/pyhss_api.log'][0m [Database] [DEBUG] Creating database [Diameter] [INFO] [Diameter] [handleConnection] [a432a406-09bc-4dc7-a18d-6419428b08c3] Connection closed for 127.0.0.1 on port 37308. [Diameter] [INFO] [Diameter] [logActivePeers] 1 Active Peers {'127.0.0.1-37308': Peer(IpAddress='127.0.0.1', Port='37308', Hostname='', Connected=False, TransportProtocol='', PeerType='', LastConnectTimestamp='2025-12-28T09:17:16.120218+00:00', LastDisconnectTimestamp='2025-12-28T09:17:16.221128+00:00', ReconnectionCount=0, Metadata='')} [1;34m[testenv][pyhss] Running pyhss_api setup script[0m [0;94m[testenv][pyhss] + ['podman', 'exec', '-e', 'CCACHE_DIR=/home/osmocom-build/ccache/testenv', '-e', 'TESTENV_CACHE_DIR=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_cache', '-e', 'TESTENV_SRC_DIR=/home/osmocom-build/jenkins/workspace', '-e', 'TESTENV_INSTALL_DIR=/', '-e', 'TERM=dumb', '-e', 'PATH=https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/_testenv/data/scripts/qemu:https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/ws/hss:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin', '-e', 'HOME=/home/osmocom-build', '-e', 'PYTHONUNBUFFERED=1', '-t', '-w', 'https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/logs/pyhss_api', 'testenv-hss-pyhss-osmocom-nightly-20251228-0917-4d65f3c9-0', 'sh', '-c', './setup_db.sh'][0m + wait_for_port.py -p 8080 [Database] [DEBUG] Database already created [Database] [INFO] Not loading EIR IMEI TAC Database as Redis not enabled or TAC CSV Database not set in config [Database] [DEBUG] Table apn already exists [Database] [DEBUG] Table auc already exists [Database] [DEBUG] Table subscriber already exists [Database] [DEBUG] Table subscriber_routing already exists [Database] [DEBUG] Table serving_apn already exists [Database] [DEBUG] Table ims_subscriber already exists [Database] [DEBUG] Table roaming_network already exists [Database] [DEBUG] Table emergency_subscriber already exists [Database] [DEBUG] Table roaming_rule already exists [Database] [DEBUG] Table charging_rule already exists [Database] [DEBUG] Table tft already exists [Database] [DEBUG] Table eir already exists [Database] [DEBUG] Table eir_history already exists [Database] [DEBUG] Table subscriber_attributes already exists [Database] [DEBUG] Creating table operation_log [Database] [INFO] Not loading EIR IMEI TAC Database as Redis not enabled or TAC CSV Database not set in config [Database] [DEBUG] Table apn already exists [Database] [DEBUG] Table auc already exists [Database] [DEBUG] Table subscriber already exists [Database] [DEBUG] Table subscriber_routing already exists [Database] [DEBUG] Table serving_apn already exists [Database] [DEBUG] Table ims_subscriber already exists [Database] [DEBUG] Table roaming_network already exists [Database] [DEBUG] Table emergency_subscriber already exists [Database] [DEBUG] Table roaming_rule already exists [Database] [DEBUG] Table charging_rule already exists [Database] [DEBUG] Table tft already exists [Database] [DEBUG] Table eir already exists [Database] [DEBUG] Table eir_history already exists [Database] [DEBUG] Table subscriber_attributes already exists [Database] [DEBUG] Table operation_log already exists [HSS] [INFO] Initialized Diameter Library [HSS] [INFO] Origin Host: hss01 [HSS] [INFO] Realm: epc.mnc001.mcc001.3gppnetwork.org [HSS] [INFO] Product Name: pyHSS [HSS] [INFO] PLMN: 001/01 Traceback (most recent call last): File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 1967, in _exec_single_context self.dialect.do_execute( ~~~~~~~~~~~~~~~~~~~~~~~^ cursor, str_statement, effective_parameters, context ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ ) ^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/default.py", line 951, in do_execute cursor.execute(statement, parameters) ~~~~~~~~~~~~~~^^^^^^^^^^^^^^^^^^^^^^^ sqlite3.OperationalError: table operation_log already exists
The above exception was the direct cause of the following exception:
Traceback (most recent call last): File "/opt/venvs/pyhss/bin/pyhss_api", line 5, in <module> from pyhss.services.apiService import main File "/opt/venvs/pyhss/lib/python3.13/site-packages/pyhss/services/apiService.py", line 44, in <module> diameterClient = Diameter( redisMessaging=redisMessaging, ...<5 lines>... productName='PyHSS-client-API' ) File "/opt/venvs/pyhss/lib/python3.13/site-packages/pyhss/lib/diameter.py", line 48, in __init__ self.database = Database(logTool=logTool) ~~~~~~~~^^^^^^^^^^^^^^^^^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/pyhss/lib/database.py", line 413, in __init__ Base.metadata.tables[table_name].create(bind=self.engine) ~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~~^^^^^^^^^^^^^^^^^^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/sql/schema.py", line 1288, in create bind._run_ddl_visitor(ddl.SchemaGenerator, self, checkfirst=checkfirst) ~~~~~~~~~~~~~~~~~~~~~^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 3252, in _run_ddl_visitor conn._run_ddl_visitor(visitorcallable, element, **kwargs) ~~~~~~~~~~~~~~~~~~~~~^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 2459, in _run_ddl_visitor ).traverse_single(element) ~~~~~~~~~~~~~~~^^^^^^^^^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/sql/visitors.py", line 661, in traverse_single return meth(obj, **kw) File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/sql/ddl.py", line 1022, in visit_table )._invoke_with(self.connection) ~~~~~~~~~~~~^^^^^^^^^^^^^^^^^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/sql/ddl.py", line 321, in _invoke_with return bind.execute(self) ~~~~~~~~~~~~^^^^^^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 1419, in execute return meth( self, distilled_parameters, execution_options or NO_OPTIONS, ) File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/sql/ddl.py", line 187, in _execute_on_connection return connection._execute_ddl( ~~~~~~~~~~~~~~~~~~~~~~~^ self, distilled_params, execution_options ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ ) ^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 1530, in _execute_ddl ret = self._execute_context( dialect, ...<4 lines>... compiled, ) File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 1846, in _execute_context return self._exec_single_context( ~~~~~~~~~~~~~~~~~~~~~~~~~^ dialect, context, statement, parameters ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ ) ^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 1986, in _exec_single_context self._handle_dbapi_exception( ~~~~~~~~~~~~~~~~~~~~~~~~~~~~^ e, str_statement, effective_parameters, cursor, context ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ ) ^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 2355, in _handle_dbapi_exception raise sqlalchemy_exception.with_traceback(exc_info[2]) from e File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/base.py", line 1967, in _exec_single_context self.dialect.do_execute( ~~~~~~~~~~~~~~~~~~~~~~~^ cursor, str_statement, effective_parameters, context ^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^^ ) ^ File "/opt/venvs/pyhss/lib/python3.13/site-packages/sqlalchemy/engine/default.py", line 951, in do_execute cursor.execute(statement, parameters) ~~~~~~~~~~~~~~^^^^^^^^^^^^^^^^^^^^^^^ sqlalchemy.exc.OperationalError: (sqlite3.OperationalError) table operation_log already exists [SQL: CREATE TABLE operation_log ( id INTEGER NOT NULL, item_id INTEGER NOT NULL, operation_id VARCHAR(36) NOT NULL, operation VARCHAR(10), changes TEXT, last_modified VARCHAR(100), timestamp DATETIME, table_name VARCHAR(255), apn_id INTEGER, subscriber_routing_id INTEGER, serving_apn_id INTEGER, auc_id INTEGER, subscriber_id INTEGER, ims_subscriber_id INTEGER, roaming_rule_id INTEGER, roaming_network_id INTEGER, emergency_subscriber_id INTEGER, charging_rule_id INTEGER, tft_id INTEGER, eir_id INTEGER, imsi_imei_history_id INTEGER, subscriber_attributes_id INTEGER, PRIMARY KEY (id), FOREIGN KEY(apn_id) REFERENCES apn (apn_id), FOREIGN KEY(subscriber_routing_id) REFERENCES subscriber_routing (subscriber_routing_id), FOREIGN KEY(serving_apn_id) REFERENCES serving_apn (serving_apn_id), FOREIGN KEY(auc_id) REFERENCES auc (auc_id), FOREIGN KEY(subscriber_id) REFERENCES subscriber (subscriber_id), FOREIGN KEY(ims_subscriber_id) REFERENCES ims_subscriber (ims_subscriber_id), FOREIGN KEY(roaming_rule_id) REFERENCES roaming_rule (roaming_rule_id), FOREIGN KEY(roaming_network_id) REFERENCES roaming_network (roaming_network_id), FOREIGN KEY(emergency_subscriber_id) REFERENCES emergency_subscriber (emergency_subscriber_id), FOREIGN KEY(charging_rule_id) REFERENCES charging_rule (charging_rule_id), FOREIGN KEY(tft_id) REFERENCES tft (tft_id), FOREIGN KEY(eir_id) REFERENCES eir (eir_id), FOREIGN KEY(imsi_imei_history_id) REFERENCES eir_history (imsi_imei_history_id), FOREIGN KEY(subscriber_attributes_id) REFERENCES subscriber_attributes (subscriber_attributes_id) )
] (Background on this error at: https://sqlalche.me/e/20/e3q8) ERROR: 127.0.0.1:8080 did not become available within 5s! [1;91m[testenv][pyhss] pyhss_api: setup script failed[0m [1;34m[testenv][pyhss] Stopping podman container[0m [0;94m[testenv][pyhss] + ['podman', 'kill', 'testenv-hss-pyhss-osmocom-nightly-20251228-0917-4d65f3c9-0'][0m testenv-hss-pyhss-osmocom-nightly-20251228-0917-4d65f3c9-0 [0;94m[testenv] feed_watchdog_loop: podman container has stopped[0m [1;34m[testenv][pyhss] Logs saved to: https://jenkins.osmocom.org/jenkins/job/ttcn3-hss-test-pyhss/47/artifact/log... [0m + RC=1 + [ 1 = 0 ] + + uptime grep --color=always -o load.* [01;31m[Kload average: 0.59, 0.51, 0.52[m[K + exit 1 Build step 'Execute shell' marked build as failure Recording test results ERROR: Step ‘Publish JUnit test result report’ failed: No test report files were found. Configuration error?
jenkins-notifications@lists.osmocom.org