=== Test case: accounts_SUITE:registration_timeout/1 (click for source code) === Config value: [{watchdog,<0.1636.0>}, {escalus_user_db,xmpp}, {mod_register_options, [{welcome_message,{[],[]}}, {ip_access,[{allow,"127.0.0.0/8"},{deny,"0.0.0.0/0"}]}, {access,register}, {registration_watchers,[]}]}, {mim_data_dir, "/home/circleci/project/big_tests/tests/accounts_SUITE_data"}, {preset,"pgsql_mnesia"}, {tc_logfile, "/home/circleci/project/big_tests/ct_report/ct_run.test@43f5552376e6.2022-03-04_11.16.18/big_tests.tests.accounts_SUITE.logs/run.2022-03-04_11.16.22/accounts_suite.registration_timeout.html"}, {tc_group_properties,[{name,registration_timeout},sequence]}, {tc_group_path,[]}, {data_dir, "/home/circleci/project/big_tests/_build/default/lib/mongoose_tests/ebin/accounts_SUITE_data/"}, {priv_dir, "/home/circleci/project/big_tests/ct_report/ct_run.test@43f5552376e6.2022-03-04_11.16.18/big_tests.tests.accounts_SUITE.logs/run.2022-03-04_11.16.22/log_private/"}, {config_backup,#{registration_timeout => {ok,infinity}}}] === Current directory is "/home/circleci/project/big_tests/ct_report/ct_run.test@43f5552376e6.2022-03-04_11.16.18" === Started at 2022-03-04 11:16:22
*** User 2022-03-04 11:16:22.968 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:22.969 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='99ac2a922062f168' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:22.969 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:22.970 *** alicE@localhost out <iq type='get' id='85605ecbabdb8ecd7c8d75da8b727774'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:22.970 *** alicE@localhost in <iq from='localhost' id='85605ecbabdb8ecd7c8d75da8b727774' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:22.970 *** alicE@localhost out <iq type='set' id='da5792f64e38cc7ca0bc4f23d331b58b'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:22.974 *** alicE@localhost in <iq from='localhost' id='da5792f64e38cc7ca0bc4f23d331b58b' type='result'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:22.975 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:22.975 *** alicE@localhost in </stream:stream>
*** User 2022-03-04 11:16:22.975 *** bOb@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:22.976 *** bOb@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='190200a4035a4302' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:22.976 *** bOb@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:22.976 *** bOb@localhost out <iq type='get' id='7e9b4a4d5df7c1269d179dd853aa0b8c'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:22.976 *** bOb@localhost in <iq from='localhost' id='7e9b4a4d5df7c1269d179dd853aa0b8c' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:22.976 *** bOb@localhost out <iq type='set' id='0dfb63043007e8deb8d369732deca399'> <query xmlns='jabber:iq:register'> <username>bOb</username> <password>makrolika</password> </query> </iq>
*** User 2022-03-04 11:16:22.977 *** bOb@localhost in <iq from='localhost' id='0dfb63043007e8deb8d369732deca399' type='error'> <error code='500' type='wait'> <resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> <text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text> </error> </iq>
*** User 2022-03-04 11:16:22.977 *** bOb@localhost out </stream:stream>
*** User 2022-03-04 11:16:22.977 *** bOb@localhost in </stream:stream>
*** User 2022-03-04 11:16:22.978 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:22.978 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='1775956550a744c9' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:22.978 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:22.978 *** alicE@localhost out <iq type='get' id='f0fe08112a4b84c183f64e29a45c6ee3'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:22.979 *** alicE@localhost in <iq from='localhost' id='f0fe08112a4b84c183f64e29a45c6ee3' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:22.979 *** alicE@localhost out <iq type='set' id='333952812dcbb622d97c8e2fb70199cc'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:22.979 *** alicE@localhost in <iq from='localhost' id='333952812dcbb622d97c8e2fb70199cc' type='error'> <error code='500' type='wait'> <resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> <text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text> </error> </iq>
*** User 2022-03-04 11:16:22.979 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:22.980 *** alicE@localhost in </stream:stream>
*** System report during accounts_SUITE:registration_timeout/1 in registration_timeout 2022-03-04 11:16:22.980 *** =ERROR REPORT==== 4-Mar-2022::11:16:22.980086 === error when trying to register user: <iq from='localhost' id='333952812dcbb622d97c8e2fb70199cc' type='error'><error code='500' type='wait'><resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/><text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text></error></iq>
*** User 2022-03-04 11:16:23.381 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:23.381 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='9d1edfc7e67269e9' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:23.382 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:23.382 *** alicE@localhost out <iq type='get' id='2bdbf11969edcd64a42b4bbce3232291'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:23.382 *** alicE@localhost in <iq from='localhost' id='2bdbf11969edcd64a42b4bbce3232291' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:23.382 *** alicE@localhost out <iq type='set' id='d7d6f73a26b5867350dd6e94e8be9eee'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:23.382 *** alicE@localhost in <iq from='localhost' id='d7d6f73a26b5867350dd6e94e8be9eee' type='error'> <error code='500' type='wait'> <resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> <text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text> </error> </iq>
*** User 2022-03-04 11:16:23.383 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:23.383 *** alicE@localhost in </stream:stream>
*** System report during accounts_SUITE:registration_timeout/1 in registration_timeout 2022-03-04 11:16:23.383 *** =ERROR REPORT==== 4-Mar-2022::11:16:23.383281 === error when trying to register user: <iq from='localhost' id='d7d6f73a26b5867350dd6e94e8be9eee' type='error'><error code='500' type='wait'><resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/><text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text></error></iq>
*** User 2022-03-04 11:16:23.784 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:23.784 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='c1c8cbe372ed9152' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:23.785 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:23.785 *** alicE@localhost out <iq type='get' id='fe8ac11796dfaa7bc8b74182f277298a'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:23.785 *** alicE@localhost in <iq from='localhost' id='fe8ac11796dfaa7bc8b74182f277298a' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:23.786 *** alicE@localhost out <iq type='set' id='40c99cd7d42fd4fe9ee83e86db867c3b'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:23.786 *** alicE@localhost in <iq from='localhost' id='40c99cd7d42fd4fe9ee83e86db867c3b' type='error'> <error code='500' type='wait'> <resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> <text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text> </error> </iq>
*** User 2022-03-04 11:16:23.786 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:23.786 *** alicE@localhost in </stream:stream>
*** System report during accounts_SUITE:registration_timeout/1 in registration_timeout 2022-03-04 11:16:23.786 *** =ERROR REPORT==== 4-Mar-2022::11:16:23.786865 === error when trying to register user: <iq from='localhost' id='40c99cd7d42fd4fe9ee83e86db867c3b' type='error'><error code='500' type='wait'><resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/><text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text></error></iq>
*** User 2022-03-04 11:16:24.188 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:24.188 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='8d7abf27e9acde3f' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:24.188 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:24.189 *** alicE@localhost out <iq type='get' id='dc70564c0aadc073202923e0d082ca3d'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:24.189 *** alicE@localhost in <iq from='localhost' id='dc70564c0aadc073202923e0d082ca3d' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:24.189 *** alicE@localhost out <iq type='set' id='d4b711722f2cd6243dfb4123259ef857'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:24.190 *** alicE@localhost in <iq from='localhost' id='d4b711722f2cd6243dfb4123259ef857' type='error'> <error code='500' type='wait'> <resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> <text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text> </error> </iq>
*** User 2022-03-04 11:16:24.190 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:24.190 *** alicE@localhost in </stream:stream>
*** System report during accounts_SUITE:registration_timeout/1 in registration_timeout 2022-03-04 11:16:24.190 *** =ERROR REPORT==== 4-Mar-2022::11:16:24.190485 === error when trying to register user: <iq from='localhost' id='d4b711722f2cd6243dfb4123259ef857' type='error'><error code='500' type='wait'><resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/><text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text></error></iq>
*** User 2022-03-04 11:16:24.592 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:24.592 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='c98ce25b5895073b' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:24.593 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:24.593 *** alicE@localhost out <iq type='get' id='00945707fc56b80056e0dbe1b509ced9'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:24.593 *** alicE@localhost in <iq from='localhost' id='00945707fc56b80056e0dbe1b509ced9' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:24.593 *** alicE@localhost out <iq type='set' id='4bc1e69af70cbd15c7f9407ba22ce2f2'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:24.593 *** alicE@localhost in <iq from='localhost' id='4bc1e69af70cbd15c7f9407ba22ce2f2' type='error'> <error code='500' type='wait'> <resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> <text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text> </error> </iq>
*** User 2022-03-04 11:16:24.594 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:24.594 *** alicE@localhost in </stream:stream>
*** System report during accounts_SUITE:registration_timeout/1 in registration_timeout 2022-03-04 11:16:24.594 *** =ERROR REPORT==== 4-Mar-2022::11:16:24.594294 === error when trying to register user: <iq from='localhost' id='4bc1e69af70cbd15c7f9407ba22ce2f2' type='error'><error code='500' type='wait'><resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/><text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text></error></iq>
*** User 2022-03-04 11:16:24.995 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:24.995 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='74e247787adb122c' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:24.996 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:24.996 *** alicE@localhost out <iq type='get' id='009d56db0c2156772f1469de50bb4e71'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:24.996 *** alicE@localhost in <iq from='localhost' id='009d56db0c2156772f1469de50bb4e71' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:24.996 *** alicE@localhost out <iq type='set' id='7194ffa3f0ff42fd2062ffe888a9877c'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:24.997 *** alicE@localhost in <iq from='localhost' id='7194ffa3f0ff42fd2062ffe888a9877c' type='error'> <error code='500' type='wait'> <resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> <text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text> </error> </iq>
*** User 2022-03-04 11:16:24.997 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:24.997 *** alicE@localhost in </stream:stream>
*** System report during accounts_SUITE:registration_timeout/1 in registration_timeout 2022-03-04 11:16:24.998 *** =ERROR REPORT==== 4-Mar-2022::11:16:24.997938 === error when trying to register user: <iq from='localhost' id='7194ffa3f0ff42fd2062ffe888a9877c' type='error'><error code='500' type='wait'><resource-constraint xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/><text xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'>Users are not allowed to register accounts so quickly</text></error></iq>
*** User 2022-03-04 11:16:25.399 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:25.399 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='5242adeb61ffdf3c' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:25.400 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:25.400 *** alicE@localhost out <iq type='get' id='14ee852d40dc50ee7755c0c76f6be8d4'> <query xmlns='jabber:iq:register'/> </iq>
*** User 2022-03-04 11:16:25.400 *** alicE@localhost in <iq from='localhost' id='14ee852d40dc50ee7755c0c76f6be8d4' type='result'> <query xmlns='jabber:iq:register'> <instructions>Choose a username and password to register with this server</instructions> <username/> <password/> </query> </iq>
*** User 2022-03-04 11:16:25.400 *** alicE@localhost out <iq type='set' id='ef029ec921f72a8820c9cb5ca3a710d4'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> </iq>
*** User 2022-03-04 11:16:25.401 *** alicE@localhost in <iq from='localhost' id='ef029ec921f72a8820c9cb5ca3a710d4' type='error'> <query xmlns='jabber:iq:register'> <username>alicE</username> <password>matygrysa</password> </query> <error code='409' type='cancel'> <conflict xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/> </error> </iq>
*** User 2022-03-04 11:16:25.402 *** alicE@localhost out </stream:stream>
*** User 2022-03-04 11:16:25.402 *** alicE@localhost in </stream:stream>
*** System report during accounts_SUITE:registration_timeout/1 in registration_timeout 2022-03-04 11:16:25.402 *** =INFO REPORT==== 4-Mar-2022::11:16:25.402515 === user already existed: <iq from='localhost' id='ef029ec921f72a8820c9cb5ca3a710d4' type='error'><query xmlns='jabber:iq:register'><username>alicE</username><password>matygrysa</password></query><error code='409' type='cancel'><conflict xmlns='urn:ietf:params:xml:ns:xmpp-stanzas'/></error></iq>
*** User 2022-03-04 11:16:25.405 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:25.405 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='b8fec0aa6b13ad82' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:25.405 *** alicE@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:25.405 *** alicE@localhost out <auth xmlns='urn:ietf:params:xml:ns:xmpp-sasl' mechanism='PLAIN'>AGFsaWNFAG1hdHlncnlzYQ==</auth>
*** User 2022-03-04 11:16:25.406 *** alicE@localhost in <success xmlns='urn:ietf:params:xml:ns:xmpp-sasl'/>
*** User 2022-03-04 11:16:25.406 *** alicE@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:25.406 *** alicE@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='3855ff9f3d04af53' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:25.406 *** alicE@localhost in <stream:features> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'/> <session xmlns='urn:ietf:params:xml:ns:xmpp-session'/> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:25.407 *** alicE@localhost out <iq type='set' id='312b3eb996483428890888bdbb0c5929'> <bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'> <resource>escalus-default-resource</resource> </bind> </iq>
*** User 2022-03-04 11:16:25.407 *** alicE@localhost in <iq id='312b3eb996483428890888bdbb0c5929' type='result'> <bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'> <jid>alicE@localhost/escalus-default-resource</jid> </bind> </iq>
*** User 2022-03-04 11:16:25.407 *** alicE@localhost/escalus-default-resource out <iq type='set' id='b3d2f84cc15e1dbd402566df7cd11fc0'> <session xmlns='urn:ietf:params:xml:ns:xmpp-session'/> </iq>
*** User 2022-03-04 11:16:25.407 *** alicE@localhost/escalus-default-resource in <iq type='result' id='b3d2f84cc15e1dbd402566df7cd11fc0'> <session xmlns='urn:ietf:params:xml:ns:xmpp-session'/> </iq>
*** User 2022-03-04 11:16:25.408 *** alicE@localhost/escalus-default-resource out <iq type='set' id='e3b81db17bb361673c091758585dd3ac'> <query xmlns='jabber:iq:register'> <remove/> </query> </iq>
*** User 2022-03-04 11:16:25.408 *** alicE@localhost/escalus-default-resource in <iq from='' to='alicE@localhost/escalus-default-resource' id='e3b81db17bb361673c091758585dd3ac' type='result'/>
*** User 2022-03-04 11:16:25.408 *** alicE@localhost/escalus-default-resource out </stream:stream>
*** User 2022-03-04 11:16:25.409 *** alicE@localhost/escalus-default-resource in </stream:stream>
*** User 2022-03-04 11:16:25.409 *** bOb@localhost out <stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-03-04 11:16:25.409 *** bOb@localhost in <stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='7137ae1f93187f76' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-03-04 11:16:25.410 *** bOb@localhost in <stream:features> <starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/> <compression xmlns='http://jabber.org/features/compress'> <method>zlib</method> </compression> <mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <mechanism>SCRAM-SHA-256</mechanism> <mechanism>PLAIN</mechanism> </mechanisms> <register xmlns='http://jabber.org/features/iq-register'/> <amp xmlns='http://jabber.org/feature/amp'/> <sm xmlns='urn:xmpp:sm:3'/> </stream:features>
*** User 2022-03-04 11:16:25.410 *** bOb@localhost out <auth xmlns='urn:ietf:params:xml:ns:xmpp-sasl' mechanism='PLAIN'>AGJPYgBtYWtyb2xpa2E=</auth>
*** User 2022-03-04 11:16:25.411 *** bOb@localhost in <failure xmlns='urn:ietf:params:xml:ns:xmpp-sasl'> <not-authorized/> </failure>
=== WARNING: end_per_testcase crashed! Reason: {badmatch, {error, {connection_step_failed, {{escalus_session,authenticate}, {client,<<"bOb@localhost">>,escalus_tcp,<0.1664.0>,undefined, [{username,<<"bOb">>}, {server,<<"localhost">>}, {host,<<"localhost">>}, {port,5222}, {auth,{escalus_auth,auth_plain}}, {wspath,undefined}, {username,<<"bOb">>}, {server,<<"localhost">>}, {password,<<"makrolika">>}, {stream_id,<<"7137ae1f93187f76">>}]}, [{compression,[<<"zlib">>]}, {starttls,true}, {stream_management,true}, {advanced_message_processing,true}, {client_state_indication,false}, {sasl_mechanisms,[<<"SCRAM-SHA-256">>,<<"PLAIN">>]}, {caps,undefined}]}, {auth_failed,<<"bOb">>, {xmlel,<<"failure">>, [{<<"xmlns">>,<<"urn:ietf:params:xml:ns:xmpp-sasl">>}], [{xmlel,<<"not-authorized">>,[],[]}]}}}}} Line: [{escalus_users,delete_user,297}, {escalus_users,'-delete_users/2-lc$^0/1-0-',110}, {escalus_users,'-delete_users/2-lc$^0/1-0-',110}, {accounts_SUITE,end_per_testcase,173}, {test_server,do_end_per_testcase,1598}, {test_server,run_test_case_eval1,1306}, {test_server,run_test_case_eval,1195}]
=== Ended at 2022-03-04 11:16:25 === successfully completed test case === === Returned value: {ok,ok}
Test run history | Top level test index | Latest test result