[Qa-jenkins-scm] Build failed in Jenkins: reproducible_scheduler #33432

Mon Aug 30 10:40:19 BST 2021

See <https://jenkins.debian.net/job/reproducible_scheduler/33432/display/redirect>

Changes:

------------------------------------------
Started by timer
Running as SYSTEM
[EnvInject] - Loading node environment variables.
Building on master in workspace <https://jenkins.debian.net/job/reproducible_scheduler/ws/>
[workspace] $ /bin/sh -xe /tmp/jenkins9427554394771192598.sh
+ /srv/jenkins/bin/reproducible_scheduler.py
/srv/jenkins/bin/reproducible_scheduler.py:15: DeprecationWarning: please use 'debian.deb822' instead
  import deb822
[2021-08-30 09:23:00] INFO: Starting at 2021-08-30 09:23:00.675819
[2021-08-30 09:23:00] INFO: Updating sources tables for all suites.
[2021-08-30 09:23:00] INFO: Downloading sources file for stretch: http://deb.debian.org/debian/dists/stretch/main/source/Sources.xz
[2021-08-30 09:23:02] INFO: Updating sources db for stretch/amd64...
/usr/lib/python3/dist-packages/debian/deb822.py:748: UserWarning: Parsing of Deb822 data with python-apt's apt_pkg was requested but this cannot be done on non-file input.
  warnings.warn(msg)
[2021-08-30 09:23:22] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:23:37] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:23:37] INFO: DB update done for stretch/amd64 done at 2021-08-30 09:23:37.
[2021-08-30 09:23:37] INFO: Updating sources db for stretch/i386...
[2021-08-30 09:23:55] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:24:09] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:24:09] INFO: DB update done for stretch/i386 done at 2021-08-30 09:24:09.
[2021-08-30 09:24:09] INFO: Updating sources db for stretch/arm64...
[2021-08-30 09:24:26] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:24:42] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:24:42] INFO: DB update done for stretch/arm64 done at 2021-08-30 09:24:42.
[2021-08-30 09:24:42] INFO: Updating sources db for stretch/armhf...
[2021-08-30 09:24:59] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:25:14] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:25:14] INFO: DB update done for stretch/armhf done at 2021-08-30 09:25:14.
[2021-08-30 09:25:14] INFO: Sources for suite stretch done at 2021-08-30 09:25:14.
[2021-08-30 09:25:14] INFO: Downloading sources file for buster: http://deb.debian.org/debian/dists/buster/main/source/Sources.xz
[2021-08-30 09:25:15] INFO: Updating sources db for buster/amd64...
[2021-08-30 09:25:42] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:26:07] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:26:07] INFO: DB update done for buster/amd64 done at 2021-08-30 09:26:07.
[2021-08-30 09:26:07] INFO: Updating sources db for buster/i386...
[2021-08-30 09:26:31] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:26:55] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:26:55] INFO: DB update done for buster/i386 done at 2021-08-30 09:26:55.
[2021-08-30 09:26:55] INFO: Updating sources db for buster/arm64...
[2021-08-30 09:27:17] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:27:41] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:27:41] INFO: DB update done for buster/arm64 done at 2021-08-30 09:27:41.
[2021-08-30 09:27:41] INFO: Updating sources db for buster/armhf...
[2021-08-30 09:28:08] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:28:28] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:28:28] INFO: DB update done for buster/armhf done at 2021-08-30 09:28:28.
[2021-08-30 09:28:28] INFO: Sources for suite buster done at 2021-08-30 09:28:28.
[2021-08-30 09:28:28] INFO: Downloading sources file for bullseye: http://deb.debian.org/debian/dists/bullseye/main/source/Sources.xz
[2021-08-30 09:28:29] INFO: Updating sources db for bullseye/amd64...
[2021-08-30 09:28:56] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:29:27] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:29:27] INFO: DB update done for bullseye/amd64 done at 2021-08-30 09:29:27.
[2021-08-30 09:29:27] INFO: Updating sources db for bullseye/i386...
[2021-08-30 09:29:54] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:30:25] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:30:25] INFO: DB update done for bullseye/i386 done at 2021-08-30 09:30:25.
[2021-08-30 09:30:25] INFO: Updating sources db for bullseye/arm64...
[2021-08-30 09:30:55] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:31:24] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:31:24] INFO: DB update done for bullseye/arm64 done at 2021-08-30 09:31:24.
[2021-08-30 09:31:24] INFO: Updating sources db for bullseye/armhf...
[2021-08-30 09:31:53] INFO: Pushing 0 updated packages to the database...
[2021-08-30 09:32:18] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:32:18] INFO: DB update done for bullseye/armhf done at 2021-08-30 09:32:18.
[2021-08-30 09:32:18] INFO: Sources for suite bullseye done at 2021-08-30 09:32:18.
[2021-08-30 09:32:18] INFO: Downloading sources file for bookworm: http://deb.debian.org/debian/dists/bookworm/main/source/Sources.xz
[2021-08-30 09:32:19] INFO: Updating sources db for bookworm/amd64...
[2021-08-30 09:32:45] INFO: Pushing 6 updated packages to the database...
[2021-08-30 09:33:09] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:33:09] INFO: DB update done for bookworm/amd64 done at 2021-08-30 09:33:09.
[2021-08-30 09:33:09] INFO: Updating sources db for bookworm/i386...
[2021-08-30 09:33:31] INFO: Pushing 6 updated packages to the database...
[2021-08-30 09:34:01] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:34:02] INFO: DB update done for bookworm/i386 done at 2021-08-30 09:34:02.
[2021-08-30 09:34:02] INFO: Updating sources db for bookworm/arm64...
[2021-08-30 09:34:29] INFO: Pushing 6 updated packages to the database...
[2021-08-30 09:35:04] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:35:04] INFO: DB update done for bookworm/arm64 done at 2021-08-30 09:35:04.
[2021-08-30 09:35:04] INFO: Updating sources db for bookworm/armhf...
[2021-08-30 09:35:34] INFO: Pushing 6 updated packages to the database...
[2021-08-30 09:36:04] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:36:04] INFO: DB update done for bookworm/armhf done at 2021-08-30 09:36:04.
[2021-08-30 09:36:04] INFO: Sources for suite bookworm done at 2021-08-30 09:36:04.
[2021-08-30 09:36:04] INFO: Downloading sources file for unstable: http://deb.debian.org/debian/dists/unstable/main/source/Sources.xz
[2021-08-30 09:36:05] INFO: Updating sources db for unstable/amd64...
[2021-08-30 09:36:34] INFO: Pushing 18 updated packages to the database...
[2021-08-30 09:37:04] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:37:04] INFO: DB update done for unstable/amd64 done at 2021-08-30 09:37:04.
[2021-08-30 09:37:04] INFO: Updating sources db for unstable/i386...
[2021-08-30 09:37:34] INFO: Pushing 18 updated packages to the database...
[2021-08-30 09:38:07] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:38:08] INFO: DB update done for unstable/i386 done at 2021-08-30 09:38:08.
[2021-08-30 09:38:08] INFO: Updating sources db for unstable/arm64...
[2021-08-30 09:38:38] INFO: Pushing 18 updated packages to the database...
[2021-08-30 09:39:09] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:39:09] INFO: DB update done for unstable/arm64 done at 2021-08-30 09:39:09.
[2021-08-30 09:39:09] INFO: Updating sources db for unstable/armhf...
[2021-08-30 09:39:38] INFO: Pushing 18 updated packages to the database...
[2021-08-30 09:40:16] INFO: Now deleting 0 removed packages: []
[2021-08-30 09:40:16] INFO: DB update done for unstable/armhf done at 2021-08-30 09:40:16.
[2021-08-30 09:40:16] INFO: Sources for suite unstable done at 2021-08-30 09:40:16.
[2021-08-30 09:40:16] INFO: Downloading sources file for experimental: http://deb.debian.org/debian/dists/experimental/main/source/Sources.xz
[2021-08-30 09:40:16] INFO: Updating sources db for experimental/amd64...
[2021-08-30 09:40:18] INFO: Pushing 2 updated packages to the database...
[2021-08-30 09:40:18] INFO: Now inserting 2 new sources in the database: [{'name': 'zaqar-tempest-plugin', 'version': '1.3.0-1', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'tempest', 'version': '1:28.0.0-1', 'suite': 'experimental', 'architecture': 'amd64'}]
[2021-08-30 09:40:18] INFO: Now deleting 53 removed packages: ['pgbackrest', 'mozjs78', 'ruby-gollum-rugged-adapter', 'ruby-prometheus-client-mmap', 'kdeclarative', 'frameworkintegration', 'golang-github-grpc-ecosystem-go-grpc-middleware', 'ruby-ruby-magic-static', 'gap-io', 'golang-gopkg-libgit2-git2go.v31', 'kross', 'knewstuff', 'kxmlrpcclient', 'ircii', 'monit', 'golang-github-spf13-cobra', 'sip6', 'bluez-qt', 'qqc2-desktop-style', 'gap-grape', 'kbookmarks', 'plasma-framework', 'baloo-kf5', 'kcmutils', 'knotifyconfig', 'kwallet-kf5', 'kxmlgui', 'libtraceevent', 'khtml', 'primesieve', 'kquickcharts', 'pango1.0', 'tightvnc', 'golang-github-containers-storage', 'purpose', 'ktexteditor', 'ecflow', 'django-taggit', 'kdelibs4support', 'kio', 'libtracefs', 'kparts', 'osmnx', 'krunner', 'tree-sitter', 'golang-github-openshift-imagebuilder', 'fonttools', 'runit', 'kdav', 'kdewebkit', 'kinit', 'kmediaplayer', 'golang-github-containers-buildah']
Traceback (most recent call last):
  File "/usr/lib/python3/dist-packages/sqlalchemy/engine/base.py", line 1256, in _execute_context
    self.dialect.do_executemany(
  File "/usr/lib/python3/dist-packages/sqlalchemy/dialects/postgresql/psycopg2.py", line 898, in do_executemany
    cursor.executemany(statement, parameters)
psycopg2.errors.UniqueViolation: duplicate key value violates unique constraint "removed_packages_pkey"
DETAIL:  Key (name, suite, architecture)=(kdeclarative, experimental, amd64) already exists.

The above exception was the direct cause of the following exception:

Traceback (most recent call last):
  File "/srv/jenkins/bin/reproducible_scheduler.py", line 798, in <module>
    update_sources(suite)
  File "/srv/jenkins/bin/reproducible_scheduler.py", line 304, in update_sources
    update_sources_db(suite, arch, sources)
  File "/srv/jenkins/bin/reproducible_scheduler.py", line 425, in update_sources_db
    conn_db.execute(removed_packages_table.insert(), pkgs_to_rm)
  File "/usr/lib/python3/dist-packages/sqlalchemy/engine/base.py", line 1011, in execute
    return meth(self, multiparams, params)
  File "/usr/lib/python3/dist-packages/sqlalchemy/sql/elements.py", line 298, in _execute_on_connection
    return connection._execute_clauseelement(self, multiparams, params)
  File "/usr/lib/python3/dist-packages/sqlalchemy/engine/base.py", line 1124, in _execute_clauseelement
    ret = self._execute_context(
  File "/usr/lib/python3/dist-packages/sqlalchemy/engine/base.py", line 1316, in _execute_context
    self._handle_dbapi_exception(
  File "/usr/lib/python3/dist-packages/sqlalchemy/engine/base.py", line 1510, in _handle_dbapi_exception
    util.raise_(
  File "/usr/lib/python3/dist-packages/sqlalchemy/util/compat.py", line 182, in raise_
    raise exception
  File "/usr/lib/python3/dist-packages/sqlalchemy/engine/base.py", line 1256, in _execute_context
    self.dialect.do_executemany(
  File "/usr/lib/python3/dist-packages/sqlalchemy/dialects/postgresql/psycopg2.py", line 898, in do_executemany
    cursor.executemany(statement, parameters)
sqlalchemy.exc.IntegrityError: (psycopg2.errors.UniqueViolation) duplicate key value violates unique constraint "removed_packages_pkey"
DETAIL:  Key (name, suite, architecture)=(kdeclarative, experimental, amd64) already exists.

[SQL: INSERT INTO removed_packages (name, suite, architecture) VALUES (%(name)s, %(suite)s, %(architecture)s)]
[parameters: ({'name': 'pgbackrest', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'mozjs78', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'ruby-gollum-rugged-adapter', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'ruby-prometheus-client-mmap', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'kdeclarative', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'frameworkintegration', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'golang-github-grpc-ecosystem-go-grpc-middleware', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'ruby-ruby-magic-static', 'suite': 'experimental', 'architecture': 'amd64'}  ... displaying 10 of 53 total bound parameter sets ...  {'name': 'kmediaplayer', 'suite': 'experimental', 'architecture': 'amd64'}, {'name': 'golang-github-containers-buildah', 'suite': 'experimental', 'architecture': 'amd64'})]
(Background on this error at: http://sqlalche.me/e/13/gkpj)
[2021-08-30 09:40:18] INFO: Finished at 2021-08-30 09:40:18.732055, took: 0:17:18.057585
Build step 'Execute shell' marked build as failure