0s autopkgtest [15:32:57]: starting date and time: 2025-10-20 15:32:57+0000 0s autopkgtest [15:32:57]: git checkout: 4b346b80 nova: make wait_reboot return success even when a no-op 0s autopkgtest [15:32:57]: host juju-7f2275-prod-proposed-migration-environment-20; command line: /home/ubuntu/autopkgtest/runner/autopkgtest --output-dir /tmp/autopkgtest-work.ga8hiat8/out --timeout-copy=6000 --setup-commands /home/ubuntu/autopkgtest-cloud/worker-config-production/setup-canonical.sh --apt-pocket=proposed=src:pytest,src:python-pluggy --apt-upgrade django-cas-server --timeout-short=300 --timeout-copy=20000 --timeout-build=20000 '--env=ADT_TEST_TRIGGERS=pytest/8.4.2-1 python-pluggy/1.6.0-1' -- ssh -s /home/ubuntu/autopkgtest/ssh-setup/nova -- --flavor autopkgtest-s390x --security-groups autopkgtest-juju-7f2275-prod-proposed-migration-environment-20@bos03-s390x-13.secgroup --name adt-resolute-s390x-django-cas-server-20251020-153257-juju-7f2275-prod-proposed-migration-environment-20-4fe66e1f-c525-44cf-bfef-2fca0bc9094b --image adt/ubuntu-resolute-s390x-server --keyname testbed-juju-7f2275-prod-proposed-migration-environment-20 --net-id=net_prod-proposed-migration-s390x -e TERM=linux --mirror=http://ftpmaster.internal/ubuntu/ 3s Creating nova instance adt-resolute-s390x-django-cas-server-20251020-153257-juju-7f2275-prod-proposed-migration-environment-20-4fe66e1f-c525-44cf-bfef-2fca0bc9094b from image adt/ubuntu-resolute-s390x-server-20251020.img (UUID af6042e7-5f94-4102-8fd4-5557e2338897)... 43s autopkgtest [15:33:40]: testbed dpkg architecture: s390x 44s autopkgtest [15:33:41]: testbed apt version: 3.1.8ubuntu1 44s autopkgtest [15:33:41]: @@@@@@@@@@@@@@@@@@@@ test bed setup 44s autopkgtest [15:33:41]: testbed release detected to be: None 45s autopkgtest [15:33:42]: updating testbed package index (apt update) 45s Get:1 http://ftpmaster.internal/ubuntu resolute-proposed InRelease [83.3 kB] 46s Hit:2 http://ftpmaster.internal/ubuntu resolute InRelease 46s Hit:3 http://ftpmaster.internal/ubuntu resolute-updates InRelease 46s Hit:4 http://ftpmaster.internal/ubuntu resolute-security InRelease 46s Get:5 http://ftpmaster.internal/ubuntu resolute-proposed/restricted Sources [5028 B] 46s Get:6 http://ftpmaster.internal/ubuntu resolute-proposed/multiverse Sources [14.3 kB] 46s Get:7 http://ftpmaster.internal/ubuntu resolute-proposed/main Sources [56.9 kB] 46s Get:8 http://ftpmaster.internal/ubuntu resolute-proposed/universe Sources [646 kB] 46s Get:9 http://ftpmaster.internal/ubuntu resolute-proposed/main s390x Packages [107 kB] 46s Get:10 http://ftpmaster.internal/ubuntu resolute-proposed/restricted s390x Packages [940 B] 46s Get:11 http://ftpmaster.internal/ubuntu resolute-proposed/universe s390x Packages [400 kB] 46s Get:12 http://ftpmaster.internal/ubuntu resolute-proposed/multiverse s390x Packages [3812 B] 46s Fetched 1318 kB in 1s (1127 kB/s) 47s Reading package lists... 47s Hit:1 http://ftpmaster.internal/ubuntu resolute-proposed InRelease 47s Hit:2 http://ftpmaster.internal/ubuntu resolute InRelease 48s Hit:3 http://ftpmaster.internal/ubuntu resolute-updates InRelease 48s Hit:4 http://ftpmaster.internal/ubuntu resolute-security InRelease 48s Reading package lists... 48s Reading package lists... 48s Building dependency tree... 48s Reading state information... 48s Calculating upgrade... 49s The following packages will be upgraded: 49s libjson-c5 python3-inflect python3-oauthlib python3-zipp 49s 4 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 49s Need to get 175 kB of archives. 49s After this operation, 31.7 kB of additional disk space will be used. 49s Get:1 http://ftpmaster.internal/ubuntu resolute/main s390x libjson-c5 s390x 0.18+ds-1.1 [36.8 kB] 49s Get:2 http://ftpmaster.internal/ubuntu resolute/main s390x python3-inflect all 7.5.0-1 [33.9 kB] 49s Get:3 http://ftpmaster.internal/ubuntu resolute/main s390x python3-oauthlib all 3.3.1-1 [93.5 kB] 49s Get:4 http://ftpmaster.internal/ubuntu resolute/main s390x python3-zipp all 3.23.0-1 [10.4 kB] 49s dpkg-preconfigure: unable to re-open stdin: No such file or directory 49s Fetched 175 kB in 0s (393 kB/s) 49s (Reading database ... (Reading database ... 5% (Reading database ... 10% (Reading database ... 15% (Reading database ... 20% (Reading database ... 25% (Reading database ... 30% (Reading database ... 35% (Reading database ... 40% (Reading database ... 45% (Reading database ... 50% (Reading database ... 55% (Reading database ... 60% (Reading database ... 65% (Reading database ... 70% (Reading database ... 75% (Reading database ... 80% (Reading database ... 85% (Reading database ... 90% (Reading database ... 95% (Reading database ... 100% (Reading database ... 56857 files and directories currently installed.) 49s Preparing to unpack .../libjson-c5_0.18+ds-1.1_s390x.deb ... 49s Unpacking libjson-c5:s390x (0.18+ds-1.1) over (0.18+ds-1) ... 49s Preparing to unpack .../python3-inflect_7.5.0-1_all.deb ... 49s Unpacking python3-inflect (7.5.0-1) over (7.3.1-2) ... 49s Preparing to unpack .../python3-oauthlib_3.3.1-1_all.deb ... 49s Unpacking python3-oauthlib (3.3.1-1) over (3.2.2-3) ... 50s Preparing to unpack .../python3-zipp_3.23.0-1_all.deb ... 50s Unpacking python3-zipp (3.23.0-1) over (3.21.0-1) ... 50s Setting up python3-zipp (3.23.0-1) ... 50s Setting up python3-inflect (7.5.0-1) ... 50s Setting up python3-oauthlib (3.3.1-1) ... 50s Setting up libjson-c5:s390x (0.18+ds-1.1) ... 50s Processing triggers for libc-bin (2.42-0ubuntu3) ... 50s autopkgtest [15:33:47]: upgrading testbed (apt dist-upgrade and autopurge) 51s Reading package lists... 51s Building dependency tree... 51s Reading state information... 51s Calculating upgrade... 51s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 51s Reading package lists... 51s Building dependency tree... 51s Reading state information... 51s Solving dependencies... 51s 0 upgraded, 0 newly installed, 0 to remove and 0 not upgraded. 53s autopkgtest [15:33:50]: testbed running kernel: Linux 6.17.0-5-generic #5-Ubuntu SMP Mon Sep 22 08:56:47 UTC 2025 53s autopkgtest [15:33:50]: @@@@@@@@@@@@@@@@@@@@ apt-source django-cas-server 55s Get:1 http://ftpmaster.internal/ubuntu resolute/universe django-cas-server 2.1.0-3 (dsc) [2597 B] 55s Get:2 http://ftpmaster.internal/ubuntu resolute/universe django-cas-server 2.1.0-3 (tar) [138 kB] 55s Get:3 http://ftpmaster.internal/ubuntu resolute/universe django-cas-server 2.1.0-3 (diff) [10.2 kB] 56s gpgv: Signature made Sat Dec 14 20:43:18 2024 UTC 56s gpgv: using RSA key 8F6DE104377F3B11E741748731F3144544A1741A 56s gpgv: issuer "tchet@debian.org" 56s gpgv: Can't check signature: No public key 56s dpkg-source: warning: cannot verify inline signature for ./django-cas-server_2.1.0-3.dsc: no acceptable signature found 56s autopkgtest [15:33:53]: testing package django-cas-server version 2.1.0-3 56s autopkgtest [15:33:53]: build not needed 56s autopkgtest [15:33:53]: test run-test-suite.sh: preparing testbed 57s Reading package lists... 57s Building dependency tree... 57s Reading state information... 57s Solving dependencies... 57s The following NEW packages will be installed: 57s fonts-font-awesome fonts-lato libjs-jquery libjs-sphinxdoc libjs-underscore 57s libxslt1.1 python3-all python3-asgiref python3-django 57s python3-django-cas-server python3-django-cas-server-doc python3-iniconfig 57s python3-legacy-cgi python3-lxml python3-packaging python3-pluggy 57s python3-pytest python3-pytest-django python3-requests-futures 57s python3-sqlparse sphinx-rtd-theme-common 57s 0 upgraded, 21 newly installed, 0 to remove and 0 not upgraded. 57s Need to get 10.2 MB of archives. 57s After this operation, 54.0 MB of additional disk space will be used. 57s Get:1 http://ftpmaster.internal/ubuntu resolute/main s390x fonts-lato all 2.015-1 [2781 kB] 58s Get:2 http://ftpmaster.internal/ubuntu resolute/main s390x fonts-font-awesome all 5.0.10+really4.7.0~dfsg-4.1 [516 kB] 58s Get:3 http://ftpmaster.internal/ubuntu resolute/main s390x libjs-jquery all 3.6.1+dfsg+~3.5.14-1 [328 kB] 58s Get:4 http://ftpmaster.internal/ubuntu resolute/main s390x libjs-underscore all 1.13.4~dfsg+~1.11.4-3 [118 kB] 58s Get:5 http://ftpmaster.internal/ubuntu resolute/main s390x libjs-sphinxdoc all 8.2.3-1ubuntu2 [28.0 kB] 58s Get:6 http://ftpmaster.internal/ubuntu resolute/main s390x libxslt1.1 s390x 1.1.43-0.1 [163 kB] 58s Get:7 http://ftpmaster.internal/ubuntu resolute/main s390x python3-all s390x 3.13.7-1 [886 B] 58s Get:8 http://ftpmaster.internal/ubuntu resolute/main s390x python3-asgiref all 3.8.1-1 [24.8 kB] 58s Get:9 http://ftpmaster.internal/ubuntu resolute/main s390x python3-sqlparse all 0.5.3-1 [32.9 kB] 58s Get:10 http://ftpmaster.internal/ubuntu resolute/main s390x python3-django all 3:5.2.4-1ubuntu2 [3036 kB] 58s Get:11 http://ftpmaster.internal/ubuntu resolute/main s390x python3-legacy-cgi all 2.6.3-1 [16.8 kB] 58s Get:12 http://ftpmaster.internal/ubuntu resolute/main s390x python3-lxml s390x 6.0.1-1 [1522 kB] 58s Get:13 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-requests-futures all 1.0.2-1 [12.0 kB] 58s Get:14 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-django-cas-server all 2.1.0-3 [111 kB] 58s Get:15 http://ftpmaster.internal/ubuntu resolute/main s390x sphinx-rtd-theme-common all 3.0.2+dfsg-3 [1013 kB] 58s Get:16 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-django-cas-server-doc all 2.1.0-3 [178 kB] 58s Get:17 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-iniconfig all 1.1.1-2 [6024 B] 58s Get:18 http://ftpmaster.internal/ubuntu resolute/main s390x python3-packaging all 25.0-1 [52.8 kB] 58s Get:19 http://ftpmaster.internal/ubuntu resolute-proposed/universe s390x python3-pluggy all 1.6.0-1 [21.0 kB] 58s Get:20 http://ftpmaster.internal/ubuntu resolute-proposed/universe s390x python3-pytest all 8.4.2-1 [268 kB] 58s Get:21 http://ftpmaster.internal/ubuntu resolute/universe s390x python3-pytest-django all 4.5.2-3 [18.5 kB] 59s Fetched 10.2 MB in 2s (6206 kB/s) 59s Selecting previously unselected package fonts-lato. 59s (Reading database ... (Reading database ... 5% (Reading database ... 10% (Reading database ... 15% (Reading database ... 20% (Reading database ... 25% (Reading database ... 30% (Reading database ... 35% (Reading database ... 40% (Reading database ... 45% (Reading database ... 50% (Reading database ... 55% (Reading database ... 60% (Reading database ... 65% (Reading database ... 70% (Reading database ... 75% (Reading database ... 80% (Reading database ... 85% (Reading database ... 90% (Reading database ... 95% (Reading database ... 100% (Reading database ... 56867 files and directories currently installed.) 59s Preparing to unpack .../00-fonts-lato_2.015-1_all.deb ... 59s Unpacking fonts-lato (2.015-1) ... 59s Selecting previously unselected package fonts-font-awesome. 59s Preparing to unpack .../01-fonts-font-awesome_5.0.10+really4.7.0~dfsg-4.1_all.deb ... 59s Unpacking fonts-font-awesome (5.0.10+really4.7.0~dfsg-4.1) ... 59s Selecting previously unselected package libjs-jquery. 59s Preparing to unpack .../02-libjs-jquery_3.6.1+dfsg+~3.5.14-1_all.deb ... 59s Unpacking libjs-jquery (3.6.1+dfsg+~3.5.14-1) ... 59s Selecting previously unselected package libjs-underscore. 59s Preparing to unpack .../03-libjs-underscore_1.13.4~dfsg+~1.11.4-3_all.deb ... 59s Unpacking libjs-underscore (1.13.4~dfsg+~1.11.4-3) ... 59s Selecting previously unselected package libjs-sphinxdoc. 59s Preparing to unpack .../04-libjs-sphinxdoc_8.2.3-1ubuntu2_all.deb ... 59s Unpacking libjs-sphinxdoc (8.2.3-1ubuntu2) ... 59s Selecting previously unselected package libxslt1.1:s390x. 59s Preparing to unpack .../05-libxslt1.1_1.1.43-0.1_s390x.deb ... 59s Unpacking libxslt1.1:s390x (1.1.43-0.1) ... 59s Selecting previously unselected package python3-all. 59s Preparing to unpack .../06-python3-all_3.13.7-1_s390x.deb ... 59s Unpacking python3-all (3.13.7-1) ... 59s Selecting previously unselected package python3-asgiref. 59s Preparing to unpack .../07-python3-asgiref_3.8.1-1_all.deb ... 59s Unpacking python3-asgiref (3.8.1-1) ... 59s Selecting previously unselected package python3-sqlparse. 59s Preparing to unpack .../08-python3-sqlparse_0.5.3-1_all.deb ... 59s Unpacking python3-sqlparse (0.5.3-1) ... 59s Selecting previously unselected package python3-django. 59s Preparing to unpack .../09-python3-django_3%3a5.2.4-1ubuntu2_all.deb ... 59s Unpacking python3-django (3:5.2.4-1ubuntu2) ... 59s Selecting previously unselected package python3-legacy-cgi. 59s Preparing to unpack .../10-python3-legacy-cgi_2.6.3-1_all.deb ... 59s Unpacking python3-legacy-cgi (2.6.3-1) ... 59s Selecting previously unselected package python3-lxml:s390x. 59s Preparing to unpack .../11-python3-lxml_6.0.1-1_s390x.deb ... 59s Unpacking python3-lxml:s390x (6.0.1-1) ... 59s Selecting previously unselected package python3-requests-futures. 59s Preparing to unpack .../12-python3-requests-futures_1.0.2-1_all.deb ... 59s Unpacking python3-requests-futures (1.0.2-1) ... 59s Selecting previously unselected package python3-django-cas-server. 59s Preparing to unpack .../13-python3-django-cas-server_2.1.0-3_all.deb ... 59s Unpacking python3-django-cas-server (2.1.0-3) ... 59s Selecting previously unselected package sphinx-rtd-theme-common. 59s Preparing to unpack .../14-sphinx-rtd-theme-common_3.0.2+dfsg-3_all.deb ... 59s Unpacking sphinx-rtd-theme-common (3.0.2+dfsg-3) ... 59s Selecting previously unselected package python3-django-cas-server-doc. 59s Preparing to unpack .../15-python3-django-cas-server-doc_2.1.0-3_all.deb ... 59s Unpacking python3-django-cas-server-doc (2.1.0-3) ... 59s Selecting previously unselected package python3-iniconfig. 59s Preparing to unpack .../16-python3-iniconfig_1.1.1-2_all.deb ... 59s Unpacking python3-iniconfig (1.1.1-2) ... 59s Selecting previously unselected package python3-packaging. 59s Preparing to unpack .../17-python3-packaging_25.0-1_all.deb ... 59s Unpacking python3-packaging (25.0-1) ... 59s Selecting previously unselected package python3-pluggy. 59s Preparing to unpack .../18-python3-pluggy_1.6.0-1_all.deb ... 59s Unpacking python3-pluggy (1.6.0-1) ... 59s Selecting previously unselected package python3-pytest. 59s Preparing to unpack .../19-python3-pytest_8.4.2-1_all.deb ... 59s Unpacking python3-pytest (8.4.2-1) ... 59s Selecting previously unselected package python3-pytest-django. 59s Preparing to unpack .../20-python3-pytest-django_4.5.2-3_all.deb ... 59s Unpacking python3-pytest-django (4.5.2-3) ... 59s Setting up python3-iniconfig (1.1.1-2) ... 60s Setting up fonts-lato (2.015-1) ... 60s Setting up python3-all (3.13.7-1) ... 60s Setting up python3-packaging (25.0-1) ... 60s Setting up python3-sqlparse (0.5.3-1) ... 60s Setting up python3-pluggy (1.6.0-1) ... 60s Setting up python3-legacy-cgi (2.6.3-1) ... 60s Setting up libxslt1.1:s390x (1.1.43-0.1) ... 60s Setting up python3-requests-futures (1.0.2-1) ... 60s Setting up libjs-jquery (3.6.1+dfsg+~3.5.14-1) ... 60s Setting up fonts-font-awesome (5.0.10+really4.7.0~dfsg-4.1) ... 60s Setting up sphinx-rtd-theme-common (3.0.2+dfsg-3) ... 60s Setting up python3-asgiref (3.8.1-1) ... 60s Setting up libjs-underscore (1.13.4~dfsg+~1.11.4-3) ... 60s Setting up python3-django (3:5.2.4-1ubuntu2) ... 61s Setting up python3-pytest (8.4.2-1) ... 61s Setting up python3-pytest-django (4.5.2-3) ... 61s Setting up libjs-sphinxdoc (8.2.3-1ubuntu2) ... 61s Setting up python3-lxml:s390x (6.0.1-1) ... 61s Setting up python3-django-cas-server (2.1.0-3) ... 61s Setting up python3-django-cas-server-doc (2.1.0-3) ... 61s Processing triggers for man-db (2.13.1-1) ... 62s Processing triggers for libc-bin (2.42-0ubuntu3) ... 63s autopkgtest [15:34:00]: test run-test-suite.sh: [----------------------- 63s 63s *************************** 63s *** Testing with python3.13 63s *************************** 63s 63s Content of current working folder: 63s 63s total 20 63s drwxr-xr-x 3 ubuntu ubuntu 4096 Oct 20 15:34 . 63s drwxrwxrwx 5 root root 4096 Oct 20 15:34 .. 63s drwxrwxr-x 9 ubuntu ubuntu 4096 Oct 20 15:33 cas_server 63s -rw-rw-r-- 1 ubuntu ubuntu 140 Aug 18 2024 pytest.ini 63s -rw-rw-r-- 1 ubuntu ubuntu 152 Aug 18 2024 setup.cfg 63s Running tests... 63s 64s ============================= test session starts ============================== 64s platform linux -- Python 3.13.7, pytest-8.4.2, pluggy-1.6.0 -- /usr/bin/python3.13 64s cachedir: .pytest_cache 64s django: settings: cas_server.tests.settings (from ini) 64s rootdir: /tmp/autopkgtest.rE6Kxa/autopkgtest_tmp 64s configfile: pytest.ini 64s testpaths: cas_server/tests/ 64s plugins: typeguard-4.4.2, django-4.5.2 64s collecting ... collected 128 items 64s 64s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_auth_federate_errors Creating test database for alias 'default'... 64s 2025-10-20 15:34:01,550 WARNING Identity provider suffix exemple.fr not found 64s 2025-10-20 15:34:01,566 INFO Got an invalid ticket ST-1ZgPN3je6A5SV7WMG2D5TeK9EOKiL8Cj2wMjkJovAdhhkskKVnsQMot6b52Yn from http://127.0.0.1:8080 for service http://testserver/federate/example.com. Retrying authentication 64s 2025-10-20 15:34:01,569 INFO Got an invalid ticket ST-MIvYax06XYxXMOt6fOp1mI7NeZ2L4XYNe4MDvMZcNwNHjd2oOVuEbno8oVMsY from http://127.0.0.1:8080 for service http://testserver/federate/example.com. Retrying authentication 64s PASSED 64s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_auth_federate_false 2025-10-20 15:34:01,597 WARNING CAS_FEDERATE is False, set it to True to use federation 64s 2025-10-20 15:34:01,598 WARNING CAS_FEDERATE is False, set it to True to use federation 64s PASSED 64s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_auth_federate_slo 2025-10-20 15:34:01,613 INFO Trying to authenticate http://127.0.0.1:8080 again 64s 2025-10-20 15:34:01,617 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 64s 2025-10-20 15:34:01,629 INFO User dédé@example.com successfully authenticated 64s 2025-10-20 15:34:01,643 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 64s 2025-10-20 15:34:01,651 INFO Trying to authenticate http://127.0.0.1:8081 again 64s 2025-10-20 15:34:01,656 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 64s 2025-10-20 15:34:01,663 INFO User dédé@example.org successfully authenticated 64s 2025-10-20 15:34:01,671 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 64s 2025-10-20 15:34:01,681 INFO Trying to authenticate http://127.0.0.1:8082 again 64s 2025-10-20 15:34:01,685 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 64s 2025-10-20 15:34:01,695 INFO User dédé@example.net successfully authenticated 64s 2025-10-20 15:34:01,704 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 64s 2025-10-20 15:34:01,715 INFO Trying to authenticate http://127.0.0.1:8083 again 64s 2025-10-20 15:34:01,722 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 64s 2025-10-20 15:34:01,732 INFO User dédé@example.test successfully authenticated 64s 2025-10-20 15:34:01,741 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 64s 2025-10-20 15:34:01,780 INFO Got an SLO requests for ticket dédé@example.net, logging out user ST-tV4BfE9bRfQlm8k8OFIi3ryNuswfZgmfgqX6JZNAEqePJ9V6zneUw7jS7v5ix 64s 2025-10-20 15:34:01,804 INFO Got an SLO requests for ticket dédé@example.test, logging out user ST-pEATM67QhEcIYkJwZMaTj2GlQ1BneSeo3MxTEwbiklhwJkOOii9c6QWI2zB0g 64s PASSED 64s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_default_settings PASSED 64s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_federate_logout 2025-10-20 15:34:01,839 INFO Trying to authenticate http://127.0.0.1:8080 again 64s 2025-10-20 15:34:01,846 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 64s 2025-10-20 15:34:01,853 INFO User dédé@example.com successfully authenticated 64s 2025-10-20 15:34:01,860 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 64s 2025-10-20 15:34:01,867 INFO Trying to authenticate http://127.0.0.1:8081 again 64s 2025-10-20 15:34:01,870 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 64s 2025-10-20 15:34:01,876 INFO User dédé@example.org successfully authenticated 64s 2025-10-20 15:34:01,883 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 64s 2025-10-20 15:34:01,890 INFO Trying to authenticate http://127.0.0.1:8082 again 64s 2025-10-20 15:34:01,892 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 64s 2025-10-20 15:34:01,899 INFO User dédé@example.net successfully authenticated 64s 2025-10-20 15:34:01,905 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 64s 2025-10-20 15:34:01,912 INFO Trying to authenticate http://127.0.0.1:8083 again 64s 2025-10-20 15:34:01,915 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 64s 2025-10-20 15:34:01,921 INFO User dédé@example.test successfully authenticated 64s 2025-10-20 15:34:01,928 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 64s 2025-10-20 15:34:01,928 INFO logout requested 64s 2025-10-20 15:34:01,930 INFO Logging out user dédé@example.com. 64s 2025-10-20 15:34:01,933 INFO User dédé@example.com logged out 64s 2025-10-20 15:34:01,938 INFO logout requested 64s 2025-10-20 15:34:01,940 INFO logout requested 64s 2025-10-20 15:34:01,941 INFO Logging out user dédé@example.org. 64s 2025-10-20 15:34:01,944 INFO User dédé@example.org logged out 64s 2025-10-20 15:34:01,951 INFO logout requested 64s 2025-10-20 15:34:01,952 INFO logout requested 64s 2025-10-20 15:34:01,954 INFO Logging out user dédé@example.net. 64s 2025-10-20 15:34:01,957 INFO User dédé@example.net logged out 64s 2025-10-20 15:34:01,962 INFO logout requested 64s 2025-10-20 15:34:01,964 INFO logout requested 64s 2025-10-20 15:34:01,965 INFO Logging out user dédé@example.test. 64s 2025-10-20 15:34:01,968 INFO User dédé@example.test logged out 65s 2025-10-20 15:34:01,975 INFO logout requested 65s 2025-10-20 15:34:01,983 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:01,986 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,019 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,025 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,031 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,035 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,041 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,047 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,054 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,056 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,063 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,068 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,075 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,078 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,084 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,090 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s 2025-10-20 15:34:02,091 INFO logout requested 65s 2025-10-20 15:34:02,092 INFO Logging out user dédé. 65s 2025-10-20 15:34:02,092 INFO User dédé logged out 65s 2025-10-20 15:34:02,099 INFO logout requested 65s 2025-10-20 15:34:02,099 INFO Logging out user dédé. 65s 2025-10-20 15:34:02,100 INFO User dédé logged out 65s 2025-10-20 15:34:02,106 INFO logout requested 65s 2025-10-20 15:34:02,106 INFO Logging out user dédé. 65s 2025-10-20 15:34:02,107 INFO User dédé logged out 65s 2025-10-20 15:34:02,113 INFO logout requested 65s 2025-10-20 15:34:02,114 INFO Logging out user dédé. 65s 2025-10-20 15:34:02,115 INFO User dédé logged out 65s PASSED 65s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_forget_provider 2025-10-20 15:34:02,130 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:02,133 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,140 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,146 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,153 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,156 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,162 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,168 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,174 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,177 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,183 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,189 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,196 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,199 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,205 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,211 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s 2025-10-20 15:34:02,212 INFO logout requested 65s 2025-10-20 15:34:02,213 INFO Logging out user dédé@example.com. 65s 2025-10-20 15:34:02,216 INFO User dédé@example.com logged out 65s 2025-10-20 15:34:02,216 INFO logout requested 65s 2025-10-20 15:34:02,217 INFO Logging out user dédé@example.org. 65s 2025-10-20 15:34:02,220 INFO User dédé@example.org logged out 65s 2025-10-20 15:34:02,221 INFO logout requested 65s 2025-10-20 15:34:02,222 INFO Logging out user dédé@example.net. 65s 2025-10-20 15:34:02,225 INFO User dédé@example.net logged out 65s 2025-10-20 15:34:02,225 INFO logout requested 65s 2025-10-20 15:34:02,226 INFO Logging out user dédé@example.test. 65s 2025-10-20 15:34:02,229 INFO User dédé@example.test logged out 65s PASSED 65s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_login_bad_ticket 2025-10-20 15:34:02,239 WARNING A login attempt failed 65s PASSED 65s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_login_get_provider PASSED 65s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_login_post_provider 2025-10-20 15:34:02,261 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:02,264 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,270 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,276 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,283 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,286 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,292 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,298 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,307 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,310 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,316 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,322 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,329 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,332 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,339 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,345 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s PASSED 65s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_login_twice 2025-10-20 15:34:02,356 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:02,359 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,365 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,371 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,378 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,381 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,387 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,393 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,400 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,403 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,409 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,415 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,422 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,425 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,431 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,437 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s 2025-10-20 15:34:02,444 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:02,448 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,454 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,459 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,466 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,469 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,475 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,481 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,488 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,491 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,498 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,504 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,511 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,514 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,520 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,527 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s 2025-10-20 15:34:02,527 WARNING User already authenticated, dropping federated authentication request 65s 2025-10-20 15:34:02,528 WARNING User already authenticated, dropping federated authentication request 65s 2025-10-20 15:34:02,529 WARNING User already authenticated, dropping federated authentication request 65s 2025-10-20 15:34:02,529 WARNING User already authenticated, dropping federated authentication request 65s PASSED 65s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_remember_provider 2025-10-20 15:34:02,540 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:02,542 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,549 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,554 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,562 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,565 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,572 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,577 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,585 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,588 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,594 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,601 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,608 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,612 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,618 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,624 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s 2025-10-20 15:34:02,625 INFO logout requested 65s 2025-10-20 15:34:02,626 INFO Logging out user dédé@example.com. 65s 2025-10-20 15:34:02,630 INFO User dédé@example.com logged out 65s 2025-10-20 15:34:02,632 INFO logout requested 65s 2025-10-20 15:34:02,633 INFO Logging out user dédé@example.org. 65s 2025-10-20 15:34:02,636 INFO User dédé@example.org logged out 65s 2025-10-20 15:34:02,638 INFO logout requested 65s 2025-10-20 15:34:02,639 INFO Logging out user dédé@example.net. 65s 2025-10-20 15:34:02,643 INFO User dédé@example.net logged out 65s 2025-10-20 15:34:02,644 INFO logout requested 65s 2025-10-20 15:34:02,646 INFO Logging out user dédé@example.test. 65s 2025-10-20 15:34:02,650 INFO User dédé@example.test logged out 65s PASSED 65s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_renew 2025-10-20 15:34:02,662 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:02,664 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,671 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,677 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,684 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,687 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,693 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,700 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,706 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,709 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,715 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,722 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,729 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,733 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,741 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,747 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s 2025-10-20 15:34:02,750 INFO Trying to authenticate http://127.0.0.1:8080 again 65s 2025-10-20 15:34:02,753 INFO Got a valid ticket for dédé from http://127.0.0.1:8080 65s 2025-10-20 15:34:02,760 INFO User dédé@example.com successfully authenticated 65s 2025-10-20 15:34:02,764 INFO Service ticket created for service https://www.example.com by user dédé@example.com. 65s 2025-10-20 15:34:02,767 INFO Trying to authenticate http://127.0.0.1:8081 again 65s 2025-10-20 15:34:02,770 INFO Got a valid ticket for dédé from http://127.0.0.1:8081 65s 2025-10-20 15:34:02,778 INFO User dédé@example.org successfully authenticated 65s 2025-10-20 15:34:02,781 INFO Service ticket created for service https://www.example.com by user dédé@example.org. 65s 2025-10-20 15:34:02,785 INFO Trying to authenticate http://127.0.0.1:8082 again 65s 2025-10-20 15:34:02,789 INFO Got a valid ticket for dédé from http://127.0.0.1:8082 65s 2025-10-20 15:34:02,795 INFO User dédé@example.net successfully authenticated 65s 2025-10-20 15:34:02,798 INFO Service ticket created for service https://www.example.com by user dédé@example.net. 65s 2025-10-20 15:34:02,802 INFO Trying to authenticate http://127.0.0.1:8083 again 65s 2025-10-20 15:34:02,805 INFO Got a valid ticket for dédé from http://127.0.0.1:8083 65s 2025-10-20 15:34:02,813 INFO User dédé@example.test successfully authenticated 65s 2025-10-20 15:34:02,816 INFO Service ticket created for service https://www.example.com by user dédé@example.test. 65s PASSED 65s cas_server/tests/test_models.py::FederatedUserTestCase::test_clean_old_entries PASSED 65s cas_server/tests/test_models.py::FederatedUserTestCase::test_json_attributes PASSED 65s cas_server/tests/test_models.py::FederateSLOTestCase::test_clean_deleted_sessions PASSED 65s cas_server/tests/test_models.py::UserAttributesTestCase::test_clean_old_entries 2025-10-20 15:34:02,843 INFO User test successfully authenticated 65s PASSED 65s cas_server/tests/test_models.py::UserTestCase::test_cached_attributs 2025-10-20 15:34:02,854 INFO User test successfully authenticated 65s PASSED 65s cas_server/tests/test_models.py::UserTestCase::test_clean_deleted_sessions 2025-10-20 15:34:02,863 INFO User test successfully authenticated 65s 2025-10-20 15:34:02,869 INFO User test successfully authenticated 65s 2025-10-20 15:34:02,876 INFO Sending SLO requests to service http://127.0.0.1:45678 for user test 65s 2025-10-20 15:34:02,879 WARNING Error during SLO for user test: HTTPConnectionPool(host='127.0.0.1', port=45678): Max retries exceeded with url: / (Caused by NewConnectionError(': Failed to establish a new connection: [Errno 111] Connection refused')) 65s PASSED 65s cas_server/tests/test_models.py::UserTestCase::test_clean_old_entries 2025-10-20 15:34:02,886 INFO User test successfully authenticated 65s PASSED 65s cas_server/tests/test_models.py::UserTestCase::test_clean_old_entries_tgt_expired 2025-10-20 15:34:02,896 INFO User test successfully authenticated 65s PASSED 65s cas_server/tests/test_models.py::TicketTestCase::test_clean_old_service_ticket 2025-10-20 15:34:02,911 INFO User test successfully authenticated 65s 2025-10-20 15:34:02,919 INFO Sending SLO requests to service http://127.0.0.1:39885 for user test 65s 2025-10-20 15:34:02,921 WARNING Error durring SLO ('Connection aborted.', RemoteDisconnected('Remote end closed connection without response')) 65s ConnectionError(ProtocolError('Connection aborted.', RemoteDisconnected('Remote end closed connection without response'))) 65s PASSED 65s cas_server/tests/test_models.py::TicketTestCase::test_json_attributes 2025-10-20 15:34:02,928 INFO User test successfully authenticated 65s PASSED 65s cas_server/tests/test_models.py::NewVersionWarningTestCase::test_send_mails PASSED 65s cas_server/tests/test_models.py::NewVersionWarningTestCase::test_send_mails_disabled PASSED 65s cas_server/tests/test_models.py::NewVersionWarningTestCase::test_send_mails_no_admins PASSED 65s cas_server/tests/test_models.py::NewVersionWarningTestCase::test_send_mails_same_version PASSED 65s cas_server/tests/test_templatetags.py::TemplateTagsTestCase::test_is_checkbox PASSED 65s cas_server/tests/test_templatetags.py::TemplateTagsTestCase::test_is_hidden PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_bad_method PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_crypt PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_hex PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_ldap_password_fail PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_ldap_password_valid PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_plain PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_plain_unicode PASSED 65s cas_server/tests/test_utils.py::CheckPasswordCase::test_setup PASSED 65s cas_server/tests/test_utils.py::UtilsTestCase::test_crypt_salt_is_valid PASSED 65s cas_server/tests/test_utils.py::UtilsTestCase::test_dictfetchall PASSED 65s cas_server/tests/test_utils.py::UtilsTestCase::test_get_current_url PASSED 65s cas_server/tests/test_utils.py::UtilsTestCase::test_get_tuple PASSED 65s cas_server/tests/test_utils.py::UtilsTestCase::test_import_attr PASSED 66s cas_server/tests/test_utils.py::UtilsTestCase::test_last_version PASSED 66s cas_server/tests/test_utils.py::UtilsTestCase::test_regexpr_validator PASSED 66s cas_server/tests/test_utils.py::UtilsTestCase::test_update_url PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_ajax_get_ticket_fail 2025-10-20 15:34:03,768 INFO User test successfully authenticated 66s 2025-10-20 15:34:03,772 WARNING Service https://www.example.org not allowed. 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_ajax_get_ticket_success 2025-10-20 15:34:03,781 INFO User test successfully authenticated 66s 2025-10-20 15:34:03,785 INFO Service ticket created for service https://www.example.com by user test. 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_ajax_get_ticket_success_alt 2025-10-20 15:34:03,793 INFO User test successfully authenticated 66s 2025-10-20 15:34:03,797 INFO Service ticket created for service https://www.example.com by user test. 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_ajax_get_ticket_warn 2025-10-20 15:34:03,805 INFO User test successfully authenticated 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_ajax_logged 2025-10-20 15:34:03,816 INFO User test successfully authenticated 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_ajax_logged_user_deleted 2025-10-20 15:34:03,827 INFO User test successfully authenticated 66s 2025-10-20 15:34:03,830 WARNING User test seems authenticated but is not found in the database. 66s 2025-10-20 15:34:03,830 INFO Logging out user test. 66s 2025-10-20 15:34:03,831 INFO User test logged out 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_ajax_login_required PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_gateway 2025-10-20 15:34:03,842 INFO User test successfully authenticated 66s 2025-10-20 15:34:03,845 WARNING Username test not allowed on service restrict_user_fail 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_login_post_missing_params 2025-10-20 15:34:03,855 WARNING A login attempt failed 66s 2025-10-20 15:34:03,864 WARNING A login attempt failed 66s 2025-10-20 15:34:03,873 WARNING A login attempt failed 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_login_view_post_badlt 2025-10-20 15:34:03,883 WARNING Received an invalid login ticket 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_login_view_post_badpass_good_lt 2025-10-20 15:34:03,894 WARNING A login attempt failed 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_login_view_post_goodpass_goodlt 2025-10-20 15:34:03,906 INFO User test successfully authenticated 66s PASSED 66s cas_server/tests/test_view.py::LoginTestCase::test_login_view_post_goodpass_goodlt_warn 2025-10-20 15:34:03,917 INFO User test successfully authenticated 66s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_lt_max PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_messages_info_box_bad_messages PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_messages_info_box_disabled PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_messages_info_box_enabled PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_new_version_available_badpypi PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_new_version_available_disabled PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_new_version_available_ok PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_renew 2025-10-20 15:34:04,503 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,510 INFO User test successfully authenticated 67s PASSED2025-10-20 15:34:04,512 INFO Service ticket created for service https://www.example.com by user test. 67s 67s cas_server/tests/test_view.py::LoginTestCase::test_renew_message_disabled 2025-10-20 15:34:04,520 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,527 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,530 INFO Service ticket created for service https://www.example.com by user test. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_service_filter 2025-10-20 15:34:04,538 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,541 WARNING User constraint failed for test, service filter_fail: ^admin$ do not match right None. 67s 2025-10-20 15:34:04,544 WARNING User constraint failed for test, service filter_fail_alt: ^toto$ do not match nom Nymous. 67s 2025-10-20 15:34:04,547 INFO Service ticket created for service https://filter_success.example.com by user test. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_service_restrict_user 2025-10-20 15:34:04,555 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,558 WARNING Username test not allowed on service restrict_user_fail 67s 2025-10-20 15:34:04,561 INFO Service ticket created for service https://restrict_user_success.example.com by user test. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_service_user_field 2025-10-20 15:34:04,568 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,572 WARNING Cannot use uid a loggin for user test on service field_needed_fail because it is absent 67s 2025-10-20 15:34:04,575 INFO Service ticket created for service https://field_needed_success.example.com by user test. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_service_user_field_evaluate_to_false 2025-10-20 15:34:04,582 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,586 WARNING Cannot use alias a loggin for user test on service field_needed_success because it is absent 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_user_logged_not_in_db 2025-10-20 15:34:04,593 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,597 WARNING User test seems authenticated but is not found in the database. 67s 2025-10-20 15:34:04,597 INFO Logging out user test. 67s 2025-10-20 15:34:04,598 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_allowed_service PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_allowed_service_no_message PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_auth_allowed_service 2025-10-20 15:34:04,618 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,622 INFO Service ticket created for service https://www.example.com/é by user test. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_auth_allowed_service_non_ascii 2025-10-20 15:34:04,631 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,635 INFO Service ticket created for service https://www.example.com by user test. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_auth_allowed_service_warn 2025-10-20 15:34:04,643 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,650 WARNING Received a login attempt for an already-active user 67s 2025-10-20 15:34:04,652 INFO Service ticket created for service https://www.example.com by user test. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_auth_denied_service 2025-10-20 15:34:04,660 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,663 WARNING Service https://www.example.org not allowed. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_denied_service 2025-10-20 15:34:04,667 WARNING Service https://www.example.net not allowed. 67s PASSED 67s cas_server/tests/test_view.py::LoginTestCase::test_view_login_get_denied_service_no_message 2025-10-20 15:34:04,673 WARNING Service https://www.example.net not allowed. 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_ajax_logout 2025-10-20 15:34:04,682 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,684 INFO logout requested 67s 2025-10-20 15:34:04,685 INFO Logging out user test. 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_ajax_logout_all_session 2025-10-20 15:34:04,687 INFO User test logged out 67s 2025-10-20 15:34:04,693 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,700 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,706 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,713 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,719 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,721 INFO logout requested 67s 2025-10-20 15:34:04,721 INFO Logging out user test from all sessions. 67s 2025-10-20 15:34:04,733 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_ajax_redirect_after_logout 2025-10-20 15:34:04,740 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,742 INFO logout requested 67s 2025-10-20 15:34:04,742 INFO Logging out user test. 67s 2025-10-20 15:34:04,745 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_logout 2025-10-20 15:34:04,746 INFO logout requested 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_logout_from_all_session 2025-10-20 15:34:04,753 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,759 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,761 INFO logout requested 67s 2025-10-20 15:34:04,762 INFO Logging out user test from all sessions. 67s 2025-10-20 15:34:04,767 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_logout_slo 2025-10-20 15:34:04,774 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,779 INFO Service ticket created for service http://127.0.0.1:33507 by user test. 67s 2025-10-20 15:34:04,781 INFO Validate: Service ticket ST-lvgStqu8HKbd9VaTxFTE9KaObvZn7yeo4m2LhocANVbw0B5bAi97m0Es9Igub validated, user test authenticated on service http://127.0.0.1:33507 67s 2025-10-20 15:34:04,782 INFO logout requested 67s 2025-10-20 15:34:04,782 INFO Logging out user test. 67s 2025-10-20 15:34:04,784 INFO Sending SLO requests to service http://127.0.0.1:33507 for user test 67s 2025-10-20 15:34:04,786 WARNING Error during SLO for user test: ('Connection aborted.', RemoteDisconnected('Remote end closed connection without response')) 67s 2025-10-20 15:34:04,787 INFO User test logged out 67s 2025-10-20 15:34:04,793 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,797 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 67s 2025-10-20 15:34:04,799 INFO Validate: Service ticket ST-inOmvIEMhmPJRDXdh84veD9ccAcSrU7rMp0q7n42dLiJU3mpvFUWWnTK5z5pE validated, user test authenticated on service http://127.0.0.1:45678 67s 2025-10-20 15:34:04,800 INFO logout requested 67s 2025-10-20 15:34:04,800 INFO Logging out user test. 67s 2025-10-20 15:34:04,802 INFO Sending SLO requests to service http://127.0.0.1:45678 for user test 67s 2025-10-20 15:34:04,804 WARNING Error during SLO for user test: ('Connection aborted.', RemoteDisconnected('Remote end closed connection without response')) 67s 2025-10-20 15:34:04,804 INFO User test logged out 67s 2025-10-20 15:34:04,809 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,814 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 67s 2025-10-20 15:34:04,816 INFO Validate: Service ticket ST-SSPs3VOJ5CCerIa4CffutJ0DZB8gPHF7oVA5UEV3TZbVk85ns6H1sZruJpa6Q validated, user test authenticated on service http://127.0.0.1:45678 67s 2025-10-20 15:34:04,817 INFO logout requested 67s 2025-10-20 15:34:04,817 INFO Logging out user test. 67s 2025-10-20 15:34:04,819 INFO Sending SLO requests to service http://127.0.0.1:45678 for user test 67s 2025-10-20 15:34:04,821 WARNING Error during SLO for user test: HTTPConnectionPool(host='127.0.0.1', port=37829): Max retries exceeded with url: / (Caused by NewConnectionError(': Failed to establish a new connection: [Errno 111] Connection refused')) 67s 2025-10-20 15:34:04,821 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_logout_view 2025-10-20 15:34:04,827 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,834 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,838 INFO logout requested 67s 2025-10-20 15:34:04,838 INFO Logging out user test. 67s 2025-10-20 15:34:04,841 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_logout_view_service 2025-10-20 15:34:04,851 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,853 INFO logout requested 67s 2025-10-20 15:34:04,853 INFO Logging out user test. 67s 2025-10-20 15:34:04,856 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_logout_view_url 2025-10-20 15:34:04,865 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,867 INFO logout requested 67s 2025-10-20 15:34:04,867 INFO Logging out user test. 67s 2025-10-20 15:34:04,870 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_redirect_after_logout 2025-10-20 15:34:04,879 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,881 INFO logout requested 67s 2025-10-20 15:34:04,882 INFO Logging out user test. 67s 2025-10-20 15:34:04,884 INFO User test logged out 67s PASSED 67s cas_server/tests/test_view.py::LogoutTestCase::test_redirect_after_logout_to_service 2025-10-20 15:34:04,890 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,892 INFO logout requested 67s 2025-10-20 15:34:04,893 INFO Logging out user test. 67s 2025-10-20 15:34:04,895 INFO User test logged out 67s 2025-10-20 15:34:04,899 INFO logout requested 67s PASSED 67s cas_server/tests/test_view.py::AuthTestCase::test_auth_view_badpass PASSED 67s cas_server/tests/test_view.py::AuthTestCase::test_auth_view_badsecret PASSED 67s cas_server/tests/test_view.py::AuthTestCase::test_auth_view_badservice 2025-10-20 15:34:04,910 WARNING Service https://www.example.org not allowed. 67s PASSED 67s cas_server/tests/test_view.py::AuthTestCase::test_auth_view_badsettings PASSED 67s cas_server/tests/test_view.py::AuthTestCase::test_auth_view_goodpass PASSED 67s cas_server/tests/test_view.py::AuthTestCase::test_auth_view_goodpass_logged 2025-10-20 15:34:04,921 INFO User test successfully authenticated 67s PASSED 67s cas_server/tests/test_view.py::AuthTestCase::test_auth_view_missing_parameter PASSED 67s cas_server/tests/test_view.py::ValidateTestCase::test_validate_missing_parameter 2025-10-20 15:34:04,933 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,938 INFO Service ticket created for service https://www.example.com by user test. 67s 2025-10-20 15:34:04,939 WARNING Validate: service or ticket missing 67s 2025-10-20 15:34:04,939 WARNING Validate: service or ticket missing 67s PASSED 67s cas_server/tests/test_view.py::ValidateTestCase::test_validate_service_renew 2025-10-20 15:34:04,945 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,947 INFO Service ticket created for service https://www.example.com by user test. 67s 2025-10-20 15:34:04,949 INFO Validate: Service ticket ST-giK63fHQuVK4Pdv0WqL2sl0dqtFxChWfqU4Wb6TTPXD0wKX9ZJyBalXHNth1E validated, user test authenticated on service https://www.example.com 67s 2025-10-20 15:34:04,954 INFO User test successfully authenticated 67s 2025-10-20 15:34:04,957 INFO Service ticket created for service https://www.example.com by user test. 67s 2025-10-20 15:34:04,959 INFO Validate: Service ticket ST-klR4DKIQjfOthSFUgTWJ2BGf4vj0WB3RKEXK2DOorkQUYdK6SZoqoUGDusIn4 validated, user test authenticated on service https://www.example.com 67s 2025-10-20 15:34:04,961 INFO Service ticket created for service https://www.example.com by user test. 67s 2025-10-20 15:34:04,963 WARNING Validate: Service ticket ST-m1Hl3WLLJnKXXpR0mmH5B0hrxgXr4n8ryigaBpX8TaVAMD88KRInvEhl7GDhZ not found or already validated, auth to https://www.example.com failed 67s PASSED 67s cas_server/tests/test_view.py::ValidateTestCase::test_validate_user_field_ok 2025-10-20 15:34:04,968 INFO User test successfully authenticated 68s 2025-10-20 15:34:04,973 INFO Service ticket created for service https://user_field.example.com by user test. 68s 2025-10-20 15:34:04,975 INFO Validate: Service ticket ST-YpFmGVED235J4TS2UwCmTNMvFmNYVSqZXFoQXDpEOHJNwCA8UDdSvXzThJwS6 validated, user test authenticated on service https://user_field.example.com 68s 2025-10-20 15:34:04,980 INFO User test successfully authenticated 68s 2025-10-20 15:34:04,984 INFO Service ticket created for service https://user_field_alt.example.com by user test. 68s 2025-10-20 15:34:04,986 INFO Validate: Service ticket ST-WW6VjLEYhmF2yq7lcUfIDWAYVc3SuV6aPxel2ALVrFLktlvWy6fQnSkcsyv3l validated, user test authenticated on service https://user_field_alt.example.com 68s PASSED 68s cas_server/tests/test_view.py::ValidateTestCase::test_validate_view_badservice 2025-10-20 15:34:04,992 INFO User test successfully authenticated 68s 2025-10-20 15:34:04,996 INFO Service ticket created for service https://www.example.com by user test. 68s 2025-10-20 15:34:04,998 WARNING Validate: Service ticket ST-K0tDC5YljPFi1nERgjAsK8GjjFVjlCbtEpbLoz1DOHolbbYxxoANTWJwU5DG2 not found or already validated, auth to https://www.example.org failed 68s PASSED 68s cas_server/tests/test_view.py::ValidateTestCase::test_validate_view_badticket 2025-10-20 15:34:05,005 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,009 INFO Service ticket created for service https://www.example.com by user test. 68s 2025-10-20 15:34:05,010 WARNING Validate: Service ticket ST-RANDOM not found or already validated, auth to https://www.example.com failed 68s PASSED 68s cas_server/tests/test_view.py::ValidateTestCase::test_validate_view_ok 2025-10-20 15:34:05,016 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,020 INFO Service ticket created for service https://www.example.com by user test. 68s 2025-10-20 15:34:05,023 INFO Validate: Service ticket ST-RNNBy5lUTs6tIk06kHcggU1lMJ44XkB8BWksl5MDkfgOQn7Fuye4HrqSRoGpm validated, user test authenticated on service https://www.example.com 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_missing_parameter 2025-10-20 15:34:05,032 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,036 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,037 WARNING ValidateService: missing ticket or service 68s PASSED2025-10-20 15:34:05,038 WARNING ValidateService: missing ticket or service 68s 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_proxy 2025-10-20 15:34:05,045 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,049 INFO Service ticket created for service http://127.0.0.1:34375 by user test. 68s 2025-10-20 15:34:05,055 INFO ValidateService: ticket ST-mRU4LRcfJGJHPEg0is7oAKhwgBoQzKu2ZFM639AH7XH68yTxZs3MbX6L21bLa validated for user test on service http://127.0.0.1:34375. Proxy Granting Ticket transmited to http://127.0.0.1:34375. 68s 2025-10-20 15:34:05,058 INFO Proxy ticket created for user test on service http://127.0.0.1:45678. 68s 2025-10-20 15:34:05,061 INFO ValidateService: ticket PT-UQDkonMsW1DvkFjf07N9gSHT8HF2YSYf8h77GJtmwEYA85GhEzsaxEBO3G7kk validated for user test on service http://127.0.0.1:45678. 68s 2025-10-20 15:34:05,065 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,070 INFO Service ticket created for service http://127.0.0.1:34981 by user test. 68s 2025-10-20 15:34:05,074 INFO ValidateService: ticket ST-XICJHCpdMHYzOrxAia367flCMZu03eGR06iHZnLHTiSd788Vk8k0pUJXz98WJ validated for user test on service http://127.0.0.1:34981. Proxy Granting Ticket transmited to http://127.0.0.1:34981. 68s 2025-10-20 15:34:05,077 INFO Proxy ticket created for user test on service http://127.0.0.1:45678. 68s 2025-10-20 15:34:05,078 WARNING ValidateService: validation error: INVALID_TICKET PT-436LtHe5pfpCQWxNc8nR9gCG7x5GxEMS3ceO1rFW26r2qbn0mPcwcelqZrsJM 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_replace_attributes 2025-10-20 15:34:05,085 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,089 INFO Service ticket created for service https://replace_attribute.example.com by user test. 68s 2025-10-20 15:34:05,092 INFO ValidateService: ticket ST-dkiJ0o1xcFG5RMAHamnoIyG7kmwCjpLWExWJadHpYK5hbkrfqht2FbqTvH575 validated for user test on service https://replace_attribute.example.com. 68s 2025-10-20 15:34:05,096 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,101 INFO Service ticket created for service https://replace_attribute_list.example.com by user test. 68s 2025-10-20 15:34:05,103 INFO ValidateService: ticket ST-Q708wzSes7rTtpRZWIJYY2orQEYiTfvsZVvnaNdOakBgCMlv0YUwJmjYq59qr validated for user test on service https://replace_attribute_list.example.com. 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_pgturl_404 2025-10-20 15:34:05,110 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,114 INFO Service ticket created for service http://127.0.0.1:42279 by user test. 68s 2025-10-20 15:34:05,118 INFO ValidateService: ticket ST-Zir5R6ObrAFJXjDM7iTL3Cp7kl6XB7C1CYlVP2jAuCXz8dRlL6vgHByZIn4IQ validated for user test on service http://127.0.0.1:42279. Proxy Granting Ticket transmited to http://127.0.0.1:42279. 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_pgturl_bad_proxy_callback 2025-10-20 15:34:05,126 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,130 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,133 WARNING ValidateService: validation error: INVALID_PROXY_CALLBACK callback url not allowed by configuration 68s 2025-10-20 15:34:05,137 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,142 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,144 WARNING Service https://www.example.org not allowed. 68s 2025-10-20 15:34:05,144 WARNING ValidateService: validation error: INVALID_PROXY_CALLBACK callback url not allowed by configuration 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_pgturl_sslerror 2025-10-20 15:34:05,151 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,156 INFO Service ticket created for service https://127.0.0.1:44279 by user test. 68s PASSED2025-10-20 15:34:05,160 WARNING ValidateService: validation error: INVALID_PROXY_CALLBACK : HTTPSConnectionPool(host='127.0.0.1', port=44279): Max retries exceeded with url: /?pgtId=PGT-b7ljSdGL4JNYxGldf18R3U8804qcQjdvZuTmqigYdFIibnFubTxNA3FHFveP&pgtIou=PGTIOU-FUYyp1UvpIqXOcd0fd1mmNkL9jILHUm5WWA2YAtpCMqJkWYxfQ6YoEKzp (Caused by SSLError(SSLError(1, '[SSL: RECORD_LAYER_FAILURE] record layer failure (_ssl.c:1033)'))) 68s 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_renew 2025-10-20 15:34:05,166 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,169 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,171 INFO ValidateService: ticket ST-1GQIXMoWNFAmHAokO8SQuy08WosgWY9oJSDxs3BQUvnzlXXnRxCgz9yVqGV19 validated for user test on service http://127.0.0.1:45678. 68s 2025-10-20 15:34:05,176 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,179 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,181 INFO ValidateService: ticket ST-aJK8kQYS2ayr4GUY7GIDa7RFkKB3OLoyOp1pRgVfiU1sl6BRCJ7DfEvoSChZt validated for user test on service http://127.0.0.1:45678. 68s 2025-10-20 15:34:05,184 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_view_badservice 2025-10-20 15:34:05,185 WARNING ValidateService: validation error: INVALID_TICKET ticket not found 68s 2025-10-20 15:34:05,191 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,196 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,197 WARNING ValidateService: validation error: INVALID_SERVICE https://www.example.org 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_view_badticket_badprefix 2025-10-20 15:34:05,205 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,209 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,210 WARNING ValidateService: validation error: INVALID_TICKET RANDOM 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_view_badticket_goodprefix 2025-10-20 15:34:05,217 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,221 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,223 WARNING ValidateService: validation error: INVALID_TICKET ticket not found 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_view_ok 2025-10-20 15:34:05,230 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,234 INFO Service ticket created for service http://127.0.0.1:45678 by user test. 68s 2025-10-20 15:34:05,236 INFO ValidateService: ticket ST-WJvxkq3l21f6nXBwbxSb20xRIJgPuHW1dQBntbY4iMZOQLR0mK2RzT1LPZBFk validated for user test on service http://127.0.0.1:45678. 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_view_ok_one_attribute 2025-10-20 15:34:05,243 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,248 INFO Service ticket created for service https://one_attribute.example.com by user test. 68s 2025-10-20 15:34:05,250 INFO ValidateService: ticket ST-2IRP3eNZG1IImGPqv1dguXhZCwaNouXhUxfjnlLEFIkITFsYr9t5sCK6Qe6Mo validated for user test on service https://one_attribute.example.com. 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_service_view_ok_pgturl 2025-10-20 15:34:05,257 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,261 INFO Service ticket created for service http://127.0.0.1:34969 by user test. 68s 2025-10-20 15:34:05,265 INFO ValidateService: ticket ST-a6ZDM014sBBfAP9MG862aPFtiFZQzOLeYiT3lzoYczEMFXLh66w2OESaTgcfp validated for user test on service http://127.0.0.1:34969. Proxy Granting Ticket transmited to http://127.0.0.1:34969. 68s PASSED 68s cas_server/tests/test_view.py::ValidateServiceTestCase::test_validate_user_field_ok 2025-10-20 15:34:05,273 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,278 INFO Service ticket created for service https://user_field.example.com by user test. 68s 2025-10-20 15:34:05,280 INFO ValidateService: ticket ST-gu6RhJT22FiccVZRXNBjvcOgQyKPWsxyeyxrzLyaWeyauEmSikybIGE525ZNh validated for user test on service https://user_field.example.com. 68s 2025-10-20 15:34:05,285 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,289 INFO Service ticket created for service https://user_field_alt.example.com by user test. 68s 2025-10-20 15:34:05,292 INFO ValidateService: ticket ST-uMkqtWmTPkMH9TbTNhmJv321yPrcxLYSHyhnrOPrCubZEvOGXXQbrmyuOm4rs validated for user test on service https://user_field_alt.example.com. 68s PASSED 68s cas_server/tests/test_view.py::ProxyTestCase::test_proxy_missing_parameter 2025-10-20 15:34:05,300 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,305 INFO Service ticket created for service http://127.0.0.1:43039 by user test. 68s 2025-10-20 15:34:05,309 INFO ValidateService: ticket ST-PBrYvGiDy1v3N027CPhELXVYIjY1uPbkRu26PRxziu7laaS28do0SEr5pxFHQ validated for user test on service http://127.0.0.1:43039. Proxy Granting Ticket transmited to http://127.0.0.1:43039. 68s 2025-10-20 15:34:05,309 WARNING Proxy: validation error: INVALID_REQUEST you must specify and pgt and targetService 68s 2025-10-20 15:34:05,310 WARNING Proxy: validation error: INVALID_REQUEST you must specify and pgt and targetService 68s PASSED 68s cas_server/tests/test_view.py::ProxyTestCase::test_proxy_unauthorized_user 2025-10-20 15:34:05,317 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,322 INFO Service ticket created for service http://127.0.0.1:37375 by user test. 68s 2025-10-20 15:34:05,326 INFO ValidateService: ticket ST-yC4QJMHT6u95R6pvCTxpDMdx6TiMLx5KTt3tlMJfmnHxMaPJdWJYA2XCoIKSA validated for user test on service http://127.0.0.1:37375. Proxy Granting Ticket transmited to http://127.0.0.1:37375. 68s 2025-10-20 15:34:05,328 WARNING Username test not allowed on service restrict_user_fail 68s 2025-10-20 15:34:05,328 WARNING Proxy: validation error: UNAUTHORIZED_USER User test not allowed on https://restrict_user_fail.example.com 68s 2025-10-20 15:34:05,330 WARNING User constraint failed for test, service filter_fail: ^admin$ do not match right None. 68s 2025-10-20 15:34:05,330 WARNING Proxy: validation error: UNAUTHORIZED_USER User test not allowed on https://filter_fail.example.com 68s 2025-10-20 15:34:05,332 WARNING Cannot use uid a loggin for user test on service field_needed_fail because it is absent 68s 2025-10-20 15:34:05,332 WARNING Proxy: validation error: UNAUTHORIZED_USER User test not allowed on https://field_needed_fail.example.com 68s PASSED 68s cas_server/tests/test_view.py::ProxyTestCase::test_validate_proxy_bad_pgt 2025-10-20 15:34:05,339 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,343 INFO Service ticket created for service http://127.0.0.1:45825 by user test. 68s 2025-10-20 15:34:05,347 INFO ValidateService: ticket ST-gZ5YGX2qBs0zlbs71pyJPeplivfEYAyPWlhI0AjEhWj4AZ4LHqBa5X4N1EMhS validated for user test on service http://127.0.0.1:45825. Proxy Granting Ticket transmited to http://127.0.0.1:45825. 68s 2025-10-20 15:34:05,349 WARNING Proxy: validation error: INVALID_TICKET PGT PGT-RANDOM not found 68s PASSED 68s cas_server/tests/test_view.py::ProxyTestCase::test_validate_proxy_bad_service 2025-10-20 15:34:05,357 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,361 INFO Service ticket created for service http://127.0.0.1:35829 by user test. 68s 2025-10-20 15:34:05,365 INFO ValidateService: ticket ST-XBcj9VyW2oiQiu39A8vo18qSBBo81uNMtezBgxVsPmnhUsrO06iNXCeFkeTF7 validated for user test on service http://127.0.0.1:35829. Proxy Granting Ticket transmited to http://127.0.0.1:35829. 68s 2025-10-20 15:34:05,366 WARNING Service https://www.example.org not allowed. 68s 2025-10-20 15:34:05,366 WARNING Proxy: validation error: UNAUTHORIZED_SERVICE https://www.example.org 68s 2025-10-20 15:34:05,367 WARNING Proxy: validation error: UNAUTHORIZED_SERVICE the service http://127.0.0.1:35829 does not allow proxy tickets 68s PASSED 68s cas_server/tests/test_view.py::ProxyTestCase::test_validate_proxy_ok 2025-10-20 15:34:05,374 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,379 INFO Service ticket created for service http://127.0.0.1:41341 by user test. 68s 2025-10-20 15:34:05,383 INFO ValidateService: ticket ST-YaqeGUORiqpnpAuM3VzFRZnOtc0VnZ7AbwiNDhLddtAGnzTe9N7LoMywjTZye validated for user test on service http://127.0.0.1:41341. Proxy Granting Ticket transmited to http://127.0.0.1:41341. 68s 2025-10-20 15:34:05,386 INFO Proxy ticket created for user test on service https://www.example.com. 68s 2025-10-20 15:34:05,388 INFO ValidateService: ticket PT-oatqjCTPjFDpglXbSu9qDwT5wkDQUWDxKDYtJQx0qLJqvOH5CHR4bF5fL3ISz validated for user test on service https://www.example.com. 68s PASSED 68s cas_server/tests/test_view.py::SamlValidateTestCase::test_saml_bad_target 2025-10-20 15:34:05,396 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,401 INFO Service ticket created for service https://www.example.com by user test. 68s 2025-10-20 15:34:05,403 WARNING SamlValidate: validation error: AuthnFailed TARGET https://www.example.org does not match ticket service 68s PASSED 68s cas_server/tests/test_view.py::SamlValidateTestCase::test_saml_bad_ticket 2025-10-20 15:34:05,408 WARNING SamlValidate: validation error: AuthnFailed ticket ST-SBOHNVsnvmzShu0OVk1coXNtBdvU9uvp8kK8dLydpQLPVlPQS465R5OcWtRlK not found 68s 2025-10-20 15:34:05,409 WARNING SamlValidate: validation error: AuthnFailed ticket PT-iU3mzs1kJRWf3kOkep02DNOZshVAqAq4iPpUvg97d3WlipMTADnUlyKdSeLcv not found 68s PASSED 68s cas_server/tests/test_view.py::SamlValidateTestCase::test_saml_bad_ticket_prefix 2025-10-20 15:34:05,413 WARNING SamlValidate: validation error: AuthnFailed ticket RANDOM-NOT-BEGINING-WITH-ST-OR-ST should begin with PT- or ST- 68s PASSED 68s cas_server/tests/test_view.py::SamlValidateTestCase::test_saml_bad_xml 2025-10-20 15:34:05,417 WARNING SamlValidate: validation error: VersionMismatch 68s PASSED 68s cas_server/tests/test_view.py::SamlValidateTestCase::test_saml_ok 2025-10-20 15:34:05,424 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,428 INFO Service ticket created for service https://www.example.com by user test. 68s 2025-10-20 15:34:05,434 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,439 INFO Service ticket created for service http://127.0.0.1:46659 by user test. 68s 2025-10-20 15:34:05,443 INFO ValidateService: ticket ST-fkyGz9b7yR1a2BBDU7NG7NXoVbGlilEqK0Jtfns7kNtRqhdTgPwEkJKF9XI9f validated for user test on service http://127.0.0.1:46659. Proxy Granting Ticket transmited to http://127.0.0.1:46659. 68s 2025-10-20 15:34:05,446 INFO Proxy ticket created for user test on service https://www.example.com. 68s 2025-10-20 15:34:05,448 INFO SamlValidate: ticket ST-JaRnSo8XKbC3P7pOUzhf12I0DHd58N6Eg9zuBnvSUAxhWGzkAiuFwHvtuLOnI validated for user test on service https://www.example.com. 68s 2025-10-20 15:34:05,450 INFO SamlValidate: ticket PT-nbcOn1aNFDgS64izRl1ZAJXv7qjezrq3LnjPdM6KVqPV7X3OwRRTfc45IKNg6 validated for user test on service https://www.example.com. 68s PASSED 68s cas_server/tests/test_view.py::SamlValidateTestCase::test_saml_ok_user_field 2025-10-20 15:34:05,457 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,462 INFO Service ticket created for service https://field_needed_success.example.com by user test. 68s 2025-10-20 15:34:05,465 INFO SamlValidate: ticket ST-8utXxRN6oLA1mSRXGRTbHLlvYWn0EWcrLJChd9Z6O3MdSw3gZdYTd8UO1CRkL validated for user test on service https://field_needed_success.example.com. 68s 2025-10-20 15:34:05,470 INFO User test successfully authenticated 68s 2025-10-20 15:34:05,474 INFO Service ticket created for service https://field_needed_success_alt.example.com by user test. 68s 2025-10-20 15:34:05,477 INFO SamlValidate: ticket ST-SXu6rWbxFmJwhZafcgWN4wL0BQ8GdSWbwNiNa9b1jcOaXvAsBoanHaPf7lWID validated for user test on service https://field_needed_success_alt.example.com. 68s PASSEDDestroying test database for alias 'default'... 68s 68s 68s =============================== warnings summary =============================== 68s cas_server/tests/test_federate.py: 8 warnings 68s cas_server/tests/test_view.py: 3 warnings 68s /tmp/autopkgtest.rE6Kxa/autopkgtest_tmp/cas_server/utils.py:211: DeprecationWarning: datetime.datetime.utcnow() is deprecated and scheduled for removal in a future version. Use timezone-aware objects to represent datetimes in UTC: datetime.datetime.now(datetime.UTC). 68s datetime.utcnow() + timedelta(seconds=max_age), 68s 68s cas_server/tests/test_federate.py::FederateAuthLoginLogoutTestCase::test_login_post_provider 68s /usr/lib/python3.13/unittest/case.py:707: DeprecationWarning: It is deprecated to return a value that is not None from a test case (>) 68s return self.run(*args, **kwds) 68s 68s -- Docs: https://docs.pytest.org/en/stable/how-to/capture-warnings.html 68s ======================= 128 passed, 12 warnings in 4.50s ======================= 68s 68s autopkgtest [15:34:05]: test run-test-suite.sh: -----------------------] 69s autopkgtest [15:34:06]: test run-test-suite.sh: - - - - - - - - - - results - - - - - - - - - - 69s run-test-suite.sh PASS 69s autopkgtest [15:34:06]: @@@@@@@@@@@@@@@@@@@@ summary 69s run-test-suite.sh PASS