Brute Force Prevention

2019-11-25 21:00:30 |

2019-11-25 21:00:30 | null / [TestClass name=class tigase.tests.server.TestBruteforcePrevention]

2019-11-25 21:00:30 | ------------------------------------

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@902bb90

2019-11-25 21:00:30 | StateChangedEvent{oldState=null, newState=connecting, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@7c554c0}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connecting}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3fad0e0}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@46f85efb}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@5abab38f}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:30 PST 2019}}}}

2019-11-25 21:00:30 | [Mutex] waiting for: [registration]

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@77f49f4c

2019-11-25 21:00:30 | StateChangedEvent{oldState=connecting, newState=connected, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@7c554c0}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3fad0e0}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@46f85efb}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@5abab38f}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=1}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:30 PST 2019}}}}

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.Connector$ConnectedHandler$ConnectedEvent@225c2c82

2019-11-25 21:00:30 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:30 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@26d7a1b4}

2019-11-25 21:00:30 | user :: null >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:30 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xml.DefaultElement@25881ca3}

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@29fe582a

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.Connector$EncryptionEstablishedHandler$EncryptionEstablishedEvent@7aa3bca6

2019-11-25 21:00:30 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@3958a74c}

2019-11-25 21:00:30 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:30 | user :: null >> <iq to="localhost" id="xrAu3bysm6ys3exdBcOYreG" type="get"><query xmlns="jabber:iq:register"/></iq>

2019-11-25 21:00:30 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@3be59dd7}

2019-11-25 21:00:30 | user :: null << <iq xmlns="jabber:client" type="result" id="xrAu3bysm6ys3exdBcOYreG" from="localhost"><query xmlns="jabber:iq:register"><instructions>Choose a user name and password for use with this service.Please also provide your e-mail address to which we will send confirmation link (MUST BE VALID!)</instructions><username/><password/><email/></query></iq>

2019-11-25 21:00:30 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@22997bd2}

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.xmpp.modules.registration.InBandRegistrationModule$ReceivedRequestedFieldsHandler$ReceivedRequestedFieldsEvent@79fd48a3

2019-11-25 21:00:30 | user :: null >> <iq to="localhost" id="XMzqhXUgzu3bysm6ys3exdB" type="set"><query xmlns="jabber:iq:register"><username>user_jl068l0027</username><password>user_jl068l0027</password><email>b3f218e1-10bd-484a-b178-3848572e27e6@localhost</email></query></iq>

2019-11-25 21:00:30 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@a14d67ad}

2019-11-25 21:00:30 | user :: null << <iq xmlns="jabber:client" type="result" id="XMzqhXUgzu3bysm6ys3exdB" from="localhost"/>

2019-11-25 21:00:30 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@1e5c8db6}

2019-11-25 21:00:30 | [Mutex] received everything.

2019-11-25 21:00:30 | [Mutex] isItemNotified: registrationSuccess :: true

2019-11-25 21:00:30 | StateChangedEvent{oldState=connected, newState=disconnecting, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@26d7a1b4, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@3958a74c]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@7c554c0}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnecting}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3fad0e0}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@46f85efb}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@5abab38f}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:30 PST 2019}}}}

2019-11-25 21:00:30 | StateChangedEvent{oldState=disconnecting, newState=disconnected, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@26d7a1b4, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@3958a74c]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@7c554c0}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3fad0e0}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@46f85efb}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@5abab38f}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:30 PST 2019}}}}

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@62c23bf6

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.JaxmppCore$LoggedOutHandler$LoggedOutEvent@b6c9b97

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@18476209

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@620c6d8a

2019-11-25 21:00:30 | tigase.jaxmpp.core.client.Connector$DisconnectedHandler$DisconnectedEvent@1162f7b6

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1jZ3FCek0zQUNWYWdhUjU0dkRmbg==</auth>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1jZ3FCek0zQUNWYWdhUjU0dkRmbkpTMXlzZmZycWhON1I1MWh3S0ZvLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9Y2dxQnpNM0FDVmFnYVI1NHZEZm5KUzF5c2ZmcnFoTjdSNTFod0tGbyxwPS9haG44OExxMjhsSXhISTlOTHhGN1NSSXVVSVpCQmQ1MFFnMU5qNzJ4OVE9</response>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <success xmlns="urn:ietf:params:xml:ns:xmpp-sasl">dj16NjJrNk51dW55ZTFKM3JGZTdXYUpTaHBxaXVISU1sZSsyS05hUmJ5bHRzPQ==</success>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><register xmlns="http://jabber.org/features/iq-register"/><csi xmlns="urn:xmpp:csi:0"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><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"><optional/></session><c hash="SHA-1" node="https://tigase.net/tigase-xmpp-server" xmlns="http://jabber.org/protocol/caps" ver="bt2mj6vq9J3s6VE0/7D8Mo0TIoU="/></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <iq xmlns="jabber:client" id="PVYgKZlZ7vn4zx4AdMDlS6E" type="set"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><resource/></bind></iq>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <iq to="user_jl068l0027@localhost/993927746-tigase-19" xmlns="jabber:client" type="result" id="PVYgKZlZ7vn4zx4AdMDlS6E"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><jid>user_jl068l0027@localhost/993927746-tigase-19</jid></bind></iq>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 >> <iq xmlns="jabber:client" id="oKpV7BwtlGOFGrX6yyuk09q" type="set"><session xmlns="urn:ietf:params:xml:ns:xmpp-session"/></iq>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 << <iq to="user_jl068l0027@localhost/993927746-tigase-19" xmlns="jabber:client" type="result" id="oKpV7BwtlGOFGrX6yyuk09q"/>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 >> <iq to="localhost" id="DUR4ukNIv9tWiWn6ql3pXbJ" type="get"><query xmlns="http://jabber.org/protocol/disco#info"/></iq>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 >> <enable xmlns="urn:xmpp:sm:3" resume="true"/>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 << <enabled resume="true" max="60" xmlns="urn:xmpp:sm:3" location="d4270859fb27" id="435f8e6b-a484-41ba-a758-ecc7b4f97cb0"/>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 >> <iq id="eCX36CAFGAFHHxl3qhXUgzu" type="get"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 >> <presence><c xmlns="http://jabber.org/protocol/caps" node="http://tigase.org/jaxmpp" ver="mg5bXbOeu1848vxdgu3jELgbQF8=" hash="sha-1"/></presence>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 << <iq to="user_jl068l0027@localhost/993927746-tigase-19" xmlns="jabber:client" type="result" id="DUR4ukNIv9tWiWn6ql3pXbJ" from="localhost"><query xmlns="http://jabber.org/protocol/disco#info"><identity type="router" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="component"/><identity type="im" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="server"/><feature var="http://jabber.org/protocol/commands"/><x xmlns="jabber:x:data" type="result"><field type="hidden" var="FORM_TYPE"><value>http://jabber.org/network/serverinfo</value></field><field type="text-multi" var="abuse-addresses"><value>mailto:abuse@localhost</value><value>xmpp:abuse@localhost</value></field></x><feature var="urn:xmpp:carbons:2"/><feature var="http://jabber.org/protocol/stats"/><feature var="http://jabber.org/protocol/amp"/><feature var="msgoffline"/><feature var="vcard-temp"/><feature var="jabber:iq:auth"/><feature var="http://jabber.org/protocol/disco#info"/><feature var="http://jabber.org/protocol/disco#items"/><feature var="urn:xmpp:blocking"/><feature var="urn:xmpp:ping"/><feature var="urn:ietf:params:xml:ns:xmpp-sasl"/><feature var="http://jabber.org/protocol/pubsub"/><feature var="http://jabber.org/protocol/pubsub#owner"/><feature var="http://jabber.org/protocol/pubsub#publish"/><identity type="pep" category="pubsub"/><feature var="urn:xmpp:pep-vcard-conversion:0"/><feature var="urn:xmpp:bookmarks-conversion:0"/><feature var="urn:xmpp:archive:auto"/><feature var="urn:xmpp:archive:manage"/><feature var="urn:xmpp:push:0"/><feature var="tigase:push:away:0"/><feature var="tigase:push:encrypt:0"/><feature var="tigase:push:ignore-unknown:0"/><feature var="tigase:push:muc:0"/><feature var="tigase:push:priority:0"/><feature var="tigase:push:muted:0"/><feature var="jabber:iq:roster"/><feature var="jabber:iq:roster-dynamic"/><feature var="urn:xmpp:mam:1"/><feature var="jabber:iq:version"/><feature var="urn:xmpp:time"/><feature var="jabber:iq:privacy"/><feature var="urn:ietf:params:xml:ns:xmpp-bind"/><feature var="http://jabber.org/protocol/commands"/><feature var="urn:ietf:params:xml:ns:vcard-4.0"/><feature var="jabber:iq:private"/><feature var="urn:ietf:params:xml:ns:xmpp-session"/></query></iq>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost/993927746-tigase-19 << <iq to="user_jl068l0027@localhost/993927746-tigase-19" xmlns="jabber:client" type="result" id="eCX36CAFGAFHHxl3qhXUgzu"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:30 | Disconnecting

2019-11-25 21:00:30 | [Mutex] notify: [disconnected]

2019-11-25 21:00:30 | [Mutex] received everything.

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <presence to="user_jl068l0027@localhost" xmlns="jabber:client" from="user_jl068l0027@localhost/993927746-tigase-19"><c hash="sha-1" node="http://tigase.org/jaxmpp" xmlns="http://jabber.org/protocol/caps" ver="mg5bXbOeu1848vxdgu3jELgbQF8="/></presence>

2019-11-25 21:00:30 | [Mutex] waiting for: [event]

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1pbDJZb25vZ0lkTFJZajAxOWdoZA==</auth>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1pbDJZb25vZ0lkTFJZajAxOWdoZHdOMWdFY1QwS0JJdDc5TnRxWDY3LHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9aWwyWW9ub2dJZExSWWowMTlnaGR3TjFnRWNUMEtCSXQ3OU50cVg2NyxwPThZR0NCZXZNRlcwRVpETXBCbXE4aFhLWTV3RGdZbEE1aUVXbElpb0ZpS0E9</response>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:30 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:30 | [Mutex] received everything.

2019-11-25 21:00:30 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:30 | [Mutex] waiting for: [event]

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1pV2N3UEhCSmp4V01MUmFUdjR0UQ==</auth>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1pV2N3UEhCSmp4V01MUmFUdjR0UUpoeXJzYlZyMnNBUTgzNmJOc0dnLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9aVdjd1BIQkpqeFdNTFJhVHY0dFFKaHlyc2JWcjJzQVE4MzZiTnNHZyxwPUt6cTFnVHM2N2tLRFVZQ1k3MlVuczI1RWRza2dFQitSTCtHdHN5SkVWb2c9</response>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:30 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:30 | [Mutex] notify: [event, disconnected]

2019-11-25 21:00:30 | [Mutex] received everything.

2019-11-25 21:00:30 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:30 | [Mutex] waiting for: [event]

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1McFg0T0lRMURmTHE4M1JxVGpEZA==</auth>

2019-11-25 21:00:30 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1McFg0T0lRMURmTHE4M1JxVGpEZHFvQjdGS0RQV0lXVURNZ0hhM2o4LHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9THBYNE9JUTFEZkxxODNScVRqRGRxb0I3RktEUFdJV1VETWdIYTNqOCxwPWpGdFFISUpVVzdiQ2Z2S3kxNDNFQkRISGxNdVNvaVVxeGJ5OUk2N2NZMVU9</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1KZWZvUGxiNzZLZlRncVA0Q1FSOQ==</auth>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1KZWZvUGxiNzZLZlRncVA0Q1FSOU1ld20zMXE4ZlFUbzR1UHVZZEpTLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9SmVmb1BsYjc2S2ZUZ3FQNENRUjlNZXdtMzFxOGZRVG80dVB1WWRKUyxwPUhUZG5BZTdzUGJlMUNSQUVSNHJ6eWduZUNNVzNyRnd2S3ZlU3k3OW5yaXc9</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1iOVk2S0RtTXRSb2RkMWFjOGpZSQ==</auth>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1iOVk2S0RtTXRSb2RkMWFjOGpZSThEUEh5ek51cHd0c1JKWFpvaE5yLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9YjlZNktEbU10Um9kZDFhYzhqWUk4RFBIeXpOdXB3dHNSSlhab2hOcixwPVBUdFdIWFIrejJWeFFOT3FYNzB6azB5em1LcGQ1QStQam51d3NrRUlnRGs9</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1RT2xvVDNVUGFaQ1Y4aWhHS25YWQ==</auth>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1RT2xvVDNVUGFaQ1Y4aWhHS25YWTFXdVQ1b3plYmFEekdGd3VBTWVJLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9UU9sb1QzVVBhWkNWOGloR0tuWFkxV3VUNW96ZWJhRHpHRnd1QU1lSSxwPWMyVlBIa1Z4REJReGlKWVRnT3paaFhyVHhaaG9ZODZsd0dIYlliNnNNRmc9</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj05NVNHQjhRRjhMSW9kdjVpWlM3WA==</auth>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj05NVNHQjhRRjhMSW9kdjVpWlM3WHhNckFZS2k1THBXR3lNaXFEeFdULHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9OTVTR0I4UUY4TElvZHY1aVpTN1h4TXJBWUtpNUxwV0d5TWlxRHhXVCxwPVNWTkNCc25vMHlBbjBVWU9aRmsvVDFoTUY5Yk9ra3Ryd1p3MVpZNWVkUFk9</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1jbE9GNm9MNHdNaWJ5VmI2MkJlMA==</auth>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1jbE9GNm9MNHdNaWJ5VmI2MkJlMDdGeXZUeHJGaDNHNHpVRjJCSFZuLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9Y2xPRjZvTDR3TWlieVZiNjJCZTA3Rnl2VHhyRmgzRzR6VUYyQkhWbixwPVB6NkhzcTBtZFZDU05BM0FPV20zbGlHaUkzdU55WURqbWVrRG9zUmhNaGs9</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] notify: [event, disconnected]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1GalpUWEZvWkMzNTM0cjB0bDhnZg==</auth>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1GalpUWEZvWkMzNTM0cjB0bDhnZnBsdFlSTWNiQ2ZoTDVoTlFZUGJyLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9RmpaVFhGb1pDMzUzNHIwdGw4Z2ZwbHRZUk1jYkNmaEw1aE5RWVBicixwPWs0OXYwM1ZhbmFiSHZqU2FLMDlUZVZLUGtpMWlNTWNiZVgwOEIveGJtQnM9</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1ZQm9sVnloald1aFlTdUlEbkUyUQ==</auth>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1ZQm9sVnloald1aFlTdUlEbkUyUWFvMWoyajd6WndJZ3N4eUpzR1JyLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9WUJvbFZ5aGpXdWhZU3VJRG5FMlFhbzFqMmo3elp3SWdzeHlKc0dScixwPS9ha2I2R1hiZURSbW1zVWJPU1dEcnlsd1FNZTJkUmtWb0kwWjFUbXBvMk09</response>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:31 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:31 | [Mutex] received everything.

2019-11-25 21:00:31 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:31 | [Mutex] waiting for: [event]

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:31 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1FNmpnekNqTlk0QjNidmlBYWdWNA==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1FNmpnekNqTlk0QjNidmlBYWdWNEpwbXlzRnZHOVQ0M2xTNFEyUEVrLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9RTZqZ3pDak5ZNEIzYnZpQWFnVjRKcG15c0Z2RzlUNDNsUzRRMlBFayxwPU13QWhtaVhRcE1zWUpKQ3prOENCL1JvcXorOVpZS3NLOWZNOTJlNTc5eWs9</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:32 | [Mutex] waiting for: [event]

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1KcWgxN1RzTXpEaFdxREdZNDBneg==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1KcWgxN1RzTXpEaFdxREdZNDBnemZHQ1B5UUFlb2pWclJmZDB4RXFsLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9SnFoMTdUc016RGhXcURHWTQwZ3pmR0NQeVFBZW9qVnJSZmQweEVxbCxwPVZLRmlLdGc0Z3R6M2gySW45UDZBNWpCck1Qc0kveXUrT0txM0VVUzlMcDg9</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:32 | [Mutex] waiting for: [event]

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj01cGJsUWtnSE1LaUlOZ1N1dWVMcg==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj01cGJsUWtnSE1LaUlOZ1N1dWVMcjVNaG1OWkdoNHVzUnNoMHE1bFcxLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9NXBibFFrZ0hNS2lJTmdTdXVlTHI1TWhtTlpHaDR1c1JzaDBxNWxXMSxwPUpEL2F4OVd5VjhQNjlpYm12WUZoUlo2SHJ2Tk8rcWJFVG1TN2pBdDRBb3M9</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:32 | [Mutex] waiting for: [event]

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj15MGttaFFLcG1UUTJHQVJqV3RFaw==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj15MGttaFFLcG1UUTJHQVJqV3RFa0lIM3VxbWowN1JMNHl0aTFzcWRKLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9eTBrbWhRS3BtVFEyR0FSald0RWtJSDN1cW1qMDdSTDR5dGkxc3FkSixwPURwUUl2RDhQQmx1RzBWUVcvTkJ0ZnFHenF3c2g5Rnp6blZHU2I4VzJqem89</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:32 | [Mutex] waiting for: [event]

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1pTU9WdllRTFNLcVRTVXRvQmdVZA==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1pTU9WdllRTFNLcVRTVXRvQmdVZHB0cGVoc3lCTWpkSkhzNlJZZjh5LHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9aU1PVnZZUUxTS3FUU1V0b0JnVWRwdHBlaHN5Qk1qZEpIczZSWWY4eSxwPU05cWZWbEJLZXZ3NTluZDRFUlBYUWlzNWUrYm4wNVpyQ3VxRGxrejJOV1U9</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:32 | [Mutex] waiting for: [event]

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1SZ2trNm81MnJDNllNY2c2SThObw==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1SZ2trNm81MnJDNllNY2c2SThOb3IwTEw0eUNEcldWU1BHckRFbkNwLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9UmdrazZvNTJyQzZZTWNnNkk4Tm9yMExMNHlDRHJXVlNQR3JERW5DcCxwPUcyaEtyZStyRU9RRXVCMFROa215NlFENTZ2MGdqcGtwOU1aSk9ZcTFwc0U9</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] notify: [event, disconnected]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:32 | [Mutex] waiting for: [event]

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj15azA5OVllMFZiUlJnMnpBV2l0RA==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj15azA5OVllMFZiUlJnMnpBV2l0RFdwNk9HNmtibmd4WHBQbTVXSEVWLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9eWswOTlZZTBWYlJSZzJ6QVdpdERXcDZPRzZrYm5neFhwUG01V0hFVixwPXVxM3NKWlJub24wVkVVNm1LRjJJc3lxQnBxQXZUaXNkT1NkSlBHQ2g5UGc9</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:32 | [Mutex] waiting for: [event]

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj02THU1aENLOG5jalU5YXEzdjJQTw==</auth>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj02THU1aENLOG5jalU5YXEzdjJQT0VtYTdnbmRpUTZTNGNNb2xYdkR2LHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9Nkx1NWhDSzhuY2pVOWFxM3YyUE9FbWE3Z25kaVE2UzRjTW9sWHZEdixwPWJnVzVFd2RuRXZscEIzNFN1N0dkNDZYbnVIb3l1YzJLSURDaDdPNTIrbGs9</response>

2019-11-25 21:00:32 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:32 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:32 | [Mutex] notify: [event, disconnected]

2019-11-25 21:00:32 | [Mutex] received everything.

2019-11-25 21:00:32 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:33 | [Mutex] waiting for: [event]

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1XYnczMkJvQzVJdllEb1l3eGYxSg==</auth>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1XYnczMkJvQzVJdllEb1l3eGYxSm9qR3Zsbnk1M1c0cXZaMEJaSXg1LHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9V2J3MzJCb0M1SXZZRG9Zd3hmMUpvakd2bG55NTNXNHF2WjBCWkl4NSxwPTJ4a3cvZ00xV1R1TXF5Wlgxd0N1Yy9CRmttNXo2Ykxsb3N3WU9pQWI3eGM9</response>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:33 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:33 | [Mutex] received everything.

2019-11-25 21:00:33 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:33 | [Mutex] notify: [event, disconnected]

2019-11-25 21:00:33 | [Mutex] waiting for: [event]

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj10YTNjS2hlVnBFTHh4SzEwTjRFOQ==</auth>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj10YTNjS2hlVnBFTHh4SzEwTjRFOWZDcjF1QVNWTFY5WGRwYWJBRDJWLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9dGEzY0toZVZwRUx4eEsxME40RTlmQ3IxdUFTVkxWOVhkcGFiQUQyVixwPVpoNlViTWVONi9EeldLRlkxZTd0em8zcW5EVzdaMkd5V3B2ZkUvNDA4Qms9</response>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:33 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:33 | [Mutex] received everything.

2019-11-25 21:00:33 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:33 | [Mutex] waiting for: [event]

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj00RThVUkxnYmxqSk1WWWhRZFBrNg==</auth>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj00RThVUkxnYmxqSk1WWWhRZFBrNlJJNnV2T3pTRGNod2E0VHo2UDJvLHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9NEU4VVJMZ2JsakpNVlloUWRQazZSSTZ1dk96U0RjaHdhNFR6NlAybyxwPVZBSmY4Y0gzaFZ4bm4yUmJpTHYzMkRGQXdzRnB0STZlNDZBc1VnWTgxYnc9</response>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:33 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:33 | [Mutex] received everything.

2019-11-25 21:00:33 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2psMDY4bDAwMjcscj1Vd21LanJVUVN2dU5XS0kwaEwxTg==</auth>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1Vd21LanJVUVN2dU5XS0kwaEwxTkwweDBXbUY2dGx6dmliY1Q2czh6LHM9SXVPdExtTW5vdHArVXc9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9VXdtS2pyVVFTdnVOV0tJMGhMMU5MMHgwV21GNnRsenZpYmNUNnM4eixwPVlJN2NNVGRmeTVBNXF5MUloOURMM2ZGa04zTkJpT3pLQXZaaXBrYWlIY0k9</response>

2019-11-25 21:00:33 | user :: user_jl068l0027@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><invalid-authzid/><text xml:lang="en">SCRAM: user_jl068l0027@localhost is not authorized to act as user_jl068l0027@localhost</text></failure>

2019-11-25 21:00:35 | [Mutex] waiting for: [user]

2019-11-25 21:00:35 | [Mutex] received everything.

2019-11-25 21:00:35 | [Mutex] isItemNotified: user:ok:false :: true

2019-11-25 21:00:35 |

2019-11-25 21:00:35 | null / [TestClass name=class tigase.tests.server.TestBruteforcePrevention]

2019-11-25 21:00:35 | ------------------------------------

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@232a4217

2019-11-25 21:00:35 | StateChangedEvent{oldState=null, newState=connecting, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@2dedb802}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connecting}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@29d22967}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@6cd0b239}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@1d9b6f4e}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:35 PST 2019}}}}

2019-11-25 21:00:35 | [Mutex] waiting for: [registration]

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@5d76f957

2019-11-25 21:00:35 | StateChangedEvent{oldState=connecting, newState=connected, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@2dedb802}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@29d22967}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@6cd0b239}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@1d9b6f4e}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=1}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:35 PST 2019}}}}

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.Connector$ConnectedHandler$ConnectedEvent@65d77a8f

2019-11-25 21:00:35 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:35 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@cff4d76}

2019-11-25 21:00:35 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:35 | user :: null >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:35 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xml.DefaultElement@25881ca3}

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@4a58b2b8

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.Connector$EncryptionEstablishedHandler$EncryptionEstablishedEvent@200e46e5

2019-11-25 21:00:35 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:35 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@7ed35369}

2019-11-25 21:00:35 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:35 | user :: null >> <iq to="localhost" id="CSDGKQ2dybvbm8CJOQbJLFB" type="get"><query xmlns="jabber:iq:register"/></iq>

2019-11-25 21:00:35 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@a1d3149c}

2019-11-25 21:00:35 | user :: null << <iq xmlns="jabber:client" type="result" id="CSDGKQ2dybvbm8CJOQbJLFB" from="localhost"><query xmlns="jabber:iq:register"><instructions>Choose a user name and password for use with this service.Please also provide your e-mail address to which we will send confirmation link (MUST BE VALID!)</instructions><username/><password/><email/></query></iq>

2019-11-25 21:00:35 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@8b13538}

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.xmpp.modules.registration.InBandRegistrationModule$ReceivedRequestedFieldsHandler$ReceivedRequestedFieldsEvent@7f39be4

2019-11-25 21:00:35 | user :: null >> <iq to="localhost" id="CTEIOYiJAfDrSaGR4mdNTV7" type="set"><query xmlns="jabber:iq:register"><username>user_3s5cau0028</username><password>user_3s5cau0028</password><email>1860e2cc-5fed-4385-89ba-da71bf42f73e@localhost</email></query></iq>

2019-11-25 21:00:35 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@f6e7d4f6}

2019-11-25 21:00:35 | user :: null << <iq xmlns="jabber:client" type="result" id="CTEIOYiJAfDrSaGR4mdNTV7" from="localhost"/>

2019-11-25 21:00:35 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@5518cc91}

2019-11-25 21:00:35 | [Mutex] received everything.

2019-11-25 21:00:35 | [Mutex] isItemNotified: registrationSuccess :: true

2019-11-25 21:00:35 | StateChangedEvent{oldState=connected, newState=disconnecting, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@cff4d76, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@7ed35369]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@2dedb802}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnecting}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@29d22967}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@6cd0b239}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@1d9b6f4e}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:35 PST 2019}}}}

2019-11-25 21:00:35 | StateChangedEvent{oldState=disconnecting, newState=disconnected, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@cff4d76, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@7ed35369]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@2dedb802}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@29d22967}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@6cd0b239}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@1d9b6f4e}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:35 PST 2019}}}}

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@31b48540

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.JaxmppCore$LoggedOutHandler$LoggedOutEvent@30ad6ebb

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@2b1afff1

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@3875d247

2019-11-25 21:00:35 | tigase.jaxmpp.core.client.Connector$DisconnectedHandler$DisconnectedEvent@2d7ede8c

2019-11-25 21:00:35 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:35 | user :: user_3s5cau0028@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyXzNzNWNhdTAwMjgscj1tNFZmU09HdVdaRFdGNm0zam9OYw==</auth>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1tNFZmU09HdVdaRFdGNm0zam9OYzlseGRZYUdxOUtSWkFPR1NLTUQ1LHM9b084MDJuTEtlaWRUekE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9bTRWZlNPR3VXWkRXRjZtM2pvTmM5bHhkWWFHcTlLUlpBT0dTS01ENSxwPTFCWWZBanhJZVFEenUzWFF4aFRBWWRkeHEyVWlGOVRXWXZNMU1VV3dkeUk9</response>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <success xmlns="urn:ietf:params:xml:ns:xmpp-sasl">dj1JNXNuZmxRTWtjV1VZNlJuSmlmV1RZTFBoZWNQUGlIc0tmc3c0V0FGeHlVPQ==</success>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><register xmlns="http://jabber.org/features/iq-register"/><csi xmlns="urn:xmpp:csi:0"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><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"><optional/></session><c hash="SHA-1" node="https://tigase.net/tigase-xmpp-server" xmlns="http://jabber.org/protocol/caps" ver="bt2mj6vq9J3s6VE0/7D8Mo0TIoU="/></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <iq xmlns="jabber:client" id="vyBChUTRUaMWeOLEnTXUeO7" type="set"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><resource/></bind></iq>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <iq to="user_3s5cau0028@localhost/993927746-tigase-20" xmlns="jabber:client" type="result" id="vyBChUTRUaMWeOLEnTXUeO7"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><jid>user_3s5cau0028@localhost/993927746-tigase-20</jid></bind></iq>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 >> <iq xmlns="jabber:client" id="vzCEl29nWeUcKQPMDpZYm4D" type="set"><session xmlns="urn:ietf:params:xml:ns:xmpp-session"/></iq>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 << <iq to="user_3s5cau0028@localhost/993927746-tigase-20" xmlns="jabber:client" type="result" id="vzCEl29nWeUcKQPMDpZYm4D"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 >> <iq to="localhost" id="6WHO0m4hGr1dqgSfQUjZhHF" type="get"><query xmlns="http://jabber.org/protocol/disco#info"/></iq>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 >> <enable xmlns="urn:xmpp:sm:3" resume="true"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 >> <iq id="8ZOWeBkJBnKUaP0eXhRRZl0" type="get"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 << <enabled resume="true" max="60" xmlns="urn:xmpp:sm:3" location="d4270859fb27" id="ece2ed65-28e6-4c39-9870-8e623353f1fb"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 >> <presence><c xmlns="http://jabber.org/protocol/caps" node="http://tigase.org/jaxmpp" ver="mg5bXbOeu1848vxdgu3jELgbQF8=" hash="sha-1"/></presence>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 << <iq to="user_3s5cau0028@localhost/993927746-tigase-20" xmlns="jabber:client" type="result" id="6WHO0m4hGr1dqgSfQUjZhHF" from="localhost"><query xmlns="http://jabber.org/protocol/disco#info"><identity type="router" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="component"/><identity type="im" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="server"/><feature var="http://jabber.org/protocol/commands"/><x xmlns="jabber:x:data" type="result"><field type="hidden" var="FORM_TYPE"><value>http://jabber.org/network/serverinfo</value></field><field type="text-multi" var="abuse-addresses"><value>mailto:abuse@localhost</value><value>xmpp:abuse@localhost</value></field></x><feature var="urn:xmpp:carbons:2"/><feature var="http://jabber.org/protocol/stats"/><feature var="http://jabber.org/protocol/amp"/><feature var="msgoffline"/><feature var="vcard-temp"/><feature var="jabber:iq:auth"/><feature var="http://jabber.org/protocol/disco#info"/><feature var="http://jabber.org/protocol/disco#items"/><feature var="urn:xmpp:blocking"/><feature var="urn:xmpp:ping"/><feature var="urn:ietf:params:xml:ns:xmpp-sasl"/><feature var="http://jabber.org/protocol/pubsub"/><feature var="http://jabber.org/protocol/pubsub#owner"/><feature var="http://jabber.org/protocol/pubsub#publish"/><identity type="pep" category="pubsub"/><feature var="urn:xmpp:pep-vcard-conversion:0"/><feature var="urn:xmpp:bookmarks-conversion:0"/><feature var="urn:xmpp:archive:auto"/><feature var="urn:xmpp:archive:manage"/><feature var="urn:xmpp:push:0"/><feature var="tigase:push:away:0"/><feature var="tigase:push:encrypt:0"/><feature var="tigase:push:ignore-unknown:0"/><feature var="tigase:push:muc:0"/><feature var="tigase:push:priority:0"/><feature var="tigase:push:muted:0"/><feature var="jabber:iq:roster"/><feature var="jabber:iq:roster-dynamic"/><feature var="urn:xmpp:mam:1"/><feature var="jabber:iq:version"/><feature var="urn:xmpp:time"/><feature var="jabber:iq:privacy"/><feature var="urn:ietf:params:xml:ns:xmpp-bind"/><feature var="http://jabber.org/protocol/commands"/><feature var="urn:ietf:params:xml:ns:vcard-4.0"/><feature var="jabber:iq:private"/><feature var="urn:ietf:params:xml:ns:xmpp-session"/></query></iq>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 << <iq to="user_3s5cau0028@localhost/993927746-tigase-20" xmlns="jabber:client" type="result" id="8ZOWeBkJBnKUaP0eXhRRZl0"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:36 | Disconnecting

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost/993927746-tigase-20 << <presence to="user_3s5cau0028@localhost" xmlns="jabber:client" from="user_3s5cau0028@localhost/993927746-tigase-20"><c hash="sha-1" node="http://tigase.org/jaxmpp" xmlns="http://jabber.org/protocol/caps" ver="mg5bXbOeu1848vxdgu3jELgbQF8="/></presence>

2019-11-25 21:00:36 | [Mutex] notify: [disconnected]

2019-11-25 21:00:36 | [Mutex] received everything.

2019-11-25 21:00:36 | [Mutex] waiting for: [event]

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyXzNzNWNhdTAwMjgscj1EV3h0VHpNQkZUZ3NWZDRRSUxscA==</auth>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1EV3h0VHpNQkZUZ3NWZDRRSUxscGEwSXR4dG5PREc4MHRaSmVQaFBtLHM9b084MDJuTEtlaWRUekE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9RFd4dFR6TUJGVGdzVmQ0UUlMbHBhMEl0eHRuT0RHODB0WkplUGhQbSxwPW9xTGtVWHFiTUZIUnlFMmdqK0FlZ1dLc3V5cW5YcnV2c29EZ2lqZmNERlk9</response>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:36 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:36 | [Mutex] received everything.

2019-11-25 21:00:36 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:36 | [Mutex] waiting for: [event]

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyXzNzNWNhdTAwMjgscj12VTlnb244QVF6emZEMEM5c1lqMA==</auth>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj12VTlnb244QVF6emZEMEM5c1lqMEhNWkhzYkl4MDVRZ0h2WXJqWUI4LHM9b084MDJuTEtlaWRUekE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9dlU5Z29uOEFRenpmRDBDOXNZajBITVpIc2JJeDA1UWdIdllyallCOCxwPWN6akpqbTFJenpyazM2dDVOTGFrWlpBK0xPekJBYmFZVGk2UGR4YU54bXc9</response>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:36 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:36 | [Mutex] received everything.

2019-11-25 21:00:36 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:36 | [Mutex] waiting for: [event]

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyXzNzNWNhdTAwMjgscj1sNHA3dVJQeEtobTlNOHhaRUVrTA==</auth>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1sNHA3dVJQeEtobTlNOHhaRUVrTGdCbXd2dGo1RjBYNnBYc1RpVjRPLHM9b084MDJuTEtlaWRUekE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9bDRwN3VSUHhLaG05TTh4WkVFa0xnQm13dnRqNUYwWDZwWHNUaVY0TyxwPUkvQldXcmVYaW1GZ21wZmFXTDRLbE5VYmxJaEV4Rk9XMW55U2F4cmxBaTQ9</response>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:36 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:36 | [Mutex] received everything.

2019-11-25 21:00:36 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:36 | [Mutex] notify: [event, disconnected]

2019-11-25 21:00:36 | [Mutex] waiting for: [event]

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyXzNzNWNhdTAwMjgscj1DVjM2R0FLMEQ3ckNRZ0d5WGNwSg==</auth>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1DVjM2R0FLMEQ3ckNRZ0d5WGNwSjRzeU9nbDlselNQSVBlZFV3RHBKLHM9b084MDJuTEtlaWRUekE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9Q1YzNkdBSzBEN3JDUWdHeVhjcEo0c3lPZ2w5bHpTUElQZWRVd0RwSixwPVNZTTg2UkRBM2JGVjRRVTRvTytzaUdTejhiN3lnRldBUjVxREZaempwbXc9</response>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:36 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:36 | [Mutex] received everything.

2019-11-25 21:00:36 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyXzNzNWNhdTAwMjgscj1odUNIVmYweHdZcGVZaUlzUE9WRw==</auth>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1odUNIVmYweHdZcGVZaUlzUE9WR1Y2RGNodXV6UTJqbFNLbjhMY2VCLHM9b084MDJuTEtlaWRUekE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9aHVDSFZmMHh3WXBlWWlJc1BPVkdWNkRjaHV1elEyamxTS244TGNlQixwPUZqTk5La2MxQUtxb0tvZlV4am1RKy9aSGpYWXl5bERkaFVCbTRqNFFGMDA9</response>

2019-11-25 21:00:36 | user :: user_3s5cau0028@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:38 | [Mutex] waiting for: [user]

2019-11-25 21:00:38 | [Mutex] received everything.

2019-11-25 21:00:38 | [Mutex] isItemNotified: user:ok:true :: true

2019-11-25 21:00:38 |

2019-11-25 21:00:38 | null / [TestClass name=class tigase.tests.server.TestBruteforcePrevention]

2019-11-25 21:00:38 | ------------------------------------

2019-11-25 21:00:38 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@56b47fde

2019-11-25 21:00:38 | StateChangedEvent{oldState=null, newState=connecting, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@58739b78}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connecting}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@5c4c14ae}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@194e9143}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@6c71573b}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:38 PST 2019}}}}

2019-11-25 21:00:38 | [Mutex] waiting for: [registration]

2019-11-25 21:00:38 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@281da996

2019-11-25 21:00:38 | StateChangedEvent{oldState=connecting, newState=connected, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@58739b78}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@5c4c14ae}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@194e9143}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@6c71573b}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=1}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:38 PST 2019}}}}

2019-11-25 21:00:38 | tigase.jaxmpp.core.client.Connector$ConnectedHandler$ConnectedEvent@14c8315f

2019-11-25 21:00:38 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:38 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:38 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@79616e0c}

2019-11-25 21:00:38 | user :: null >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:38 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xml.DefaultElement@25881ca3}

2019-11-25 21:00:38 | tigase.jaxmpp.core.client.Connector$EncryptionEstablishedHandler$EncryptionEstablishedEvent@1f4f3694

2019-11-25 21:00:38 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@5a5b7df2

2019-11-25 21:00:38 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:38 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@fccfd2f}

2019-11-25 21:00:38 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:38 | user :: null >> <iq to="localhost" id="D63sgSTUTV12uk9EwxrbvhV" type="get"><query xmlns="jabber:iq:register"/></iq>

2019-11-25 21:00:38 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@67b7c279}

2019-11-25 21:00:38 | user :: null << <iq xmlns="jabber:client" type="result" id="D63sgSTUTV12uk9EwxrbvhV" from="localhost"><query xmlns="jabber:iq:register"><instructions>Choose a user name and password for use with this service.Please also provide your e-mail address to which we will send confirmation link (MUST BE VALID!)</instructions><username/><password/><email/></query></iq>

2019-11-25 21:00:38 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@7d2ff3d4}

2019-11-25 21:00:38 | tigase.jaxmpp.core.client.xmpp.modules.registration.InBandRegistrationModule$ReceivedRequestedFieldsHandler$ReceivedRequestedFieldsEvent@1bb29173

2019-11-25 21:00:38 | user :: null >> <iq to="localhost" id="T2PVZfR2vpO4bIv5m4AysgF" type="set"><query xmlns="jabber:iq:register"><username>user_is2q4g0029</username><password>user_is2q4g0029</password><email>4632f223-0ac8-4d37-8a40-3835b3463ecc@localhost</email></query></iq>

2019-11-25 21:00:38 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@4a403adb}

2019-11-25 21:00:39 | [Mutex] received everything.

2019-11-25 21:00:39 | [Mutex] isItemNotified: registrationSuccess :: true

2019-11-25 21:00:39 | StateChangedEvent{oldState=connected, newState=disconnecting, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@79616e0c, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@fccfd2f]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@58739b78}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnecting}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@5c4c14ae}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@194e9143}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@6c71573b}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:39 PST 2019}}}}

2019-11-25 21:00:39 | user :: null << <iq xmlns="jabber:client" type="result" id="T2PVZfR2vpO4bIv5m4AysgF" from="localhost"/>

2019-11-25 21:00:39 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@1a87cb1a}

2019-11-25 21:00:39 | StateChangedEvent{oldState=disconnecting, newState=disconnected, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@79616e0c, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@fccfd2f]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@58739b78}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@5c4c14ae}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@194e9143}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@6c71573b}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:39 PST 2019}}}}

2019-11-25 21:00:39 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@724a78e0

2019-11-25 21:00:39 | tigase.jaxmpp.core.client.JaxmppCore$LoggedOutHandler$LoggedOutEvent@70f9942e

2019-11-25 21:00:39 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@7f4faa4b

2019-11-25 21:00:39 | tigase.jaxmpp.core.client.Connector$DisconnectedHandler$DisconnectedEvent@5b3471a3

2019-11-25 21:00:39 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@7a988f5d

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2lzMnE0ZzAwMjkscj1uWkZLbUlUdVdWSXk1MHJCbXI1SA==</auth>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1uWkZLbUlUdVdWSXk1MHJCbXI1SGM5cDJSeVNDNWFDOFFCVHdQMmtNLHM9YjZRUmNlTlpjM2Exa0E9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9blpGS21JVHVXVkl5NTByQm1yNUhjOXAyUnlTQzVhQzhRQlR3UDJrTSxwPVk1NmxPRHlpa1lyNVVQMTdzV1psOFpncWJmU0dMclYwNkkzSzhCM0VVUVk9</response>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <success xmlns="urn:ietf:params:xml:ns:xmpp-sasl">dj13S1NTY1dnTEM5ZHNhbEFVSTgzdEtHeFc4WlBYU1VKOTFoSWNncUg0VzJvPQ==</success>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><register xmlns="http://jabber.org/features/iq-register"/><csi xmlns="urn:xmpp:csi:0"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><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"><optional/></session><c hash="SHA-1" node="https://tigase.net/tigase-xmpp-server" xmlns="http://jabber.org/protocol/caps" ver="bt2mj6vq9J3s6VE0/7D8Mo0TIoU="/></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <iq xmlns="jabber:client" id="k2NM3tfDxrcP36El29nWeUc" type="set"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><resource/></bind></iq>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <iq to="user_is2q4g0029@localhost/993927746-tigase-21" xmlns="jabber:client" type="result" id="k2NM3tfDxrcP36El29nWeUc"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><jid>user_is2q4g0029@localhost/993927746-tigase-21</jid></bind></iq>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 >> <iq xmlns="jabber:client" id="dMZ5lGMUjYaP1lPVdKVfuqT" type="set"><session xmlns="urn:ietf:params:xml:ns:xmpp-session"/></iq>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 << <iq to="user_is2q4g0029@localhost/993927746-tigase-21" xmlns="jabber:client" type="result" id="dMZ5lGMUjYaP1lPVdKVfuqT"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 >> <iq to="localhost" id="WZAvk5z8ItiFp0maIMUX29r" type="get"><query xmlns="http://jabber.org/protocol/disco#info"/></iq>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 >> <enable xmlns="urn:xmpp:sm:3" resume="true"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 << <enabled resume="true" max="60" xmlns="urn:xmpp:sm:3" location="d4270859fb27" id="46fbd599-f8a4-4d75-af09-fc69f0af634d"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 >> <iq id="i5Q9EwxrbvhVaLVQ8jY17qc" type="get"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 >> <presence><c xmlns="http://jabber.org/protocol/caps" node="http://tigase.org/jaxmpp" ver="mg5bXbOeu1848vxdgu3jELgbQF8=" hash="sha-1"/></presence>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 << <iq to="user_is2q4g0029@localhost/993927746-tigase-21" xmlns="jabber:client" type="result" id="WZAvk5z8ItiFp0maIMUX29r" from="localhost"><query xmlns="http://jabber.org/protocol/disco#info"><identity type="router" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="component"/><identity type="im" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="server"/><feature var="http://jabber.org/protocol/commands"/><x xmlns="jabber:x:data" type="result"><field type="hidden" var="FORM_TYPE"><value>http://jabber.org/network/serverinfo</value></field><field type="text-multi" var="abuse-addresses"><value>mailto:abuse@localhost</value><value>xmpp:abuse@localhost</value></field></x><feature var="urn:xmpp:carbons:2"/><feature var="http://jabber.org/protocol/stats"/><feature var="http://jabber.org/protocol/amp"/><feature var="msgoffline"/><feature var="vcard-temp"/><feature var="jabber:iq:auth"/><feature var="http://jabber.org/protocol/disco#info"/><feature var="http://jabber.org/protocol/disco#items"/><feature var="urn:xmpp:blocking"/><feature var="urn:xmpp:ping"/><feature var="urn:ietf:params:xml:ns:xmpp-sasl"/><feature var="http://jabber.org/protocol/pubsub"/><feature var="http://jabber.org/protocol/pubsub#owner"/><feature var="http://jabber.org/protocol/pubsub#publish"/><identity type="pep" category="pubsub"/><feature var="urn:xmpp:pep-vcard-conversion:0"/><feature var="urn:xmpp:bookmarks-conversion:0"/><feature var="urn:xmpp:archive:auto"/><feature var="urn:xmpp:archive:manage"/><feature var="urn:xmpp:push:0"/><feature var="tigase:push:away:0"/><feature var="tigase:push:encrypt:0"/><feature var="tigase:push:ignore-unknown:0"/><feature var="tigase:push:muc:0"/><feature var="tigase:push:priority:0"/><feature var="tigase:push:muted:0"/><feature var="jabber:iq:roster"/><feature var="jabber:iq:roster-dynamic"/><feature var="urn:xmpp:mam:1"/><feature var="jabber:iq:version"/><feature var="urn:xmpp:time"/><feature var="jabber:iq:privacy"/><feature var="urn:ietf:params:xml:ns:xmpp-bind"/><feature var="http://jabber.org/protocol/commands"/><feature var="urn:ietf:params:xml:ns:vcard-4.0"/><feature var="jabber:iq:private"/><feature var="urn:ietf:params:xml:ns:xmpp-session"/></query></iq>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 << <iq to="user_is2q4g0029@localhost/993927746-tigase-21" xmlns="jabber:client" type="result" id="i5Q9EwxrbvhVaLVQ8jY17qc"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:39 | Disconnecting

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost/993927746-tigase-21 << <presence to="user_is2q4g0029@localhost" xmlns="jabber:client" from="user_is2q4g0029@localhost/993927746-tigase-21"><c hash="sha-1" node="http://tigase.org/jaxmpp" xmlns="http://jabber.org/protocol/caps" ver="mg5bXbOeu1848vxdgu3jELgbQF8="/></presence>

2019-11-25 21:00:39 | [Mutex] notify: [disconnected]

2019-11-25 21:00:39 | [Mutex] received everything.

2019-11-25 21:00:39 | [Mutex] waiting for: [event]

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2lzMnE0ZzAwMjkscj1PbWZsZk9YSmRzckZ2UUI4ZFdoNg==</auth>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1PbWZsZk9YSmRzckZ2UUI4ZFdoNnBXc2dpYVpiRHVFVXZKeG56WEQ5LHM9YjZRUmNlTlpjM2Exa0E9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9T21mbGZPWEpkc3JGdlFCOGRXaDZwV3NnaWFaYkR1RVV2SnhuelhEOSxwPWJFN1RWc0h5TVpkbnQwdXdWYzE2KytyY3lUU3YxNk1TZ2taeTYzaENlUTg9</response>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:39 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:39 | [Mutex] received everything.

2019-11-25 21:00:39 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:39 | [Mutex] waiting for: [event]

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="PLAIN">AHVzZXJfaXMycTRnMDAyOQAgLSAtIC0gLSAt</auth>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:39 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:39 | [Mutex] received everything.

2019-11-25 21:00:39 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:39 | [Mutex] waiting for: [event]

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="PLAIN">AHVzZXJfaXMycTRnMDAyOQAgLSAtIC0gLSAt</auth>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:39 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:39 | [Mutex] received everything.

2019-11-25 21:00:39 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:39 | [Mutex] notify: [event, disconnected]

2019-11-25 21:00:39 | [Mutex] waiting for: [event]

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="PLAIN">AHVzZXJfaXMycTRnMDAyOQAgLSAtIC0gLSAt</auth>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:39 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:39 | [Mutex] received everything.

2019-11-25 21:00:39 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2lzMnE0ZzAwMjkscj04Z3VTQUpvcFphV2VpWEhZcWJQcg==</auth>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj04Z3VTQUpvcFphV2VpWEhZcWJQckRIY1ZFVWxDY1h2MWs1TTdjaTEyLHM9YjZRUmNlTlpjM2Exa0E9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9OGd1U0FKb3BaYVdlaVhIWXFiUHJESGNWRVVsQ2NYdjFrNU03Y2kxMixwPWE5a3VrVU5iUW00N3B1eXQ0c0JnK2RpR3BXMDFReFNiYUVmdGtXVjJUajA9</response>

2019-11-25 21:00:39 | user :: user_is2q4g0029@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:41 | [Mutex] waiting for: [user]

2019-11-25 21:00:41 | [Mutex] received everything.

2019-11-25 21:00:41 | [Mutex] isItemNotified: user:ok:true :: true

2019-11-25 21:00:41 |

2019-11-25 21:00:41 | null / [TestClass name=class tigase.tests.server.TestBruteforcePrevention]

2019-11-25 21:00:41 | ------------------------------------

2019-11-25 21:00:41 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@3a808803

2019-11-25 21:00:41 | StateChangedEvent{oldState=null, newState=connecting, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@34476123}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connecting}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3078e373}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@757a6b18}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@4b043524}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:41 PST 2019}}}}

2019-11-25 21:00:41 | [Mutex] waiting for: [registration]

2019-11-25 21:00:41 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@44451b1e

2019-11-25 21:00:41 | StateChangedEvent{oldState=connecting, newState=connected, sessionObject=AbstractSessionObject{properties={TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@34476123}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=connected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3078e373}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@757a6b18}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@4b043524}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=1}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:41 PST 2019}}}}

2019-11-25 21:00:41 | tigase.jaxmpp.core.client.Connector$ConnectedHandler$ConnectedEvent@33d11b9e

2019-11-25 21:00:41 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:41 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@15559457}

2019-11-25 21:00:41 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:41 | user :: null >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:41 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xml.DefaultElement@25881ca3}

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.Connector$EncryptionEstablishedHandler$EncryptionEstablishedEvent@7f123ecc

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.Connector$StreamRestartedHandler$StreamRestaredEvent@136347db

2019-11-25 21:00:42 | StreamFeaturesReceivedEvent[<features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>]

2019-11-25 21:00:42 | user :: null << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | StanzaReceivedEvent{stanza=tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@28d5b3c2}

2019-11-25 21:00:42 | user :: null >> <iq to="localhost" id="n9W9r9FEJRISNWXZaGO0m4h" type="get"><query xmlns="jabber:iq:register"/></iq>

2019-11-25 21:00:42 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@48a1ff5e}

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.xmpp.modules.registration.InBandRegistrationModule$ReceivedRequestedFieldsHandler$ReceivedRequestedFieldsEvent@111b6da3

2019-11-25 21:00:42 | user :: null << <iq xmlns="jabber:client" type="result" id="n9W9r9FEJRISNWXZaGO0m4h" from="localhost"><query xmlns="jabber:iq:register"><instructions>Choose a user name and password for use with this service.Please also provide your e-mail address to which we will send confirmation link (MUST BE VALID!)</instructions><username/><password/><email/></query></iq>

2019-11-25 21:00:42 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@7f11d512}

2019-11-25 21:00:42 | user :: null >> <iq to="localhost" id="raXcP36El29nWeUcKQPMDpZ" type="set"><query xmlns="jabber:iq:register"><username>user_d4p4k80030</username><password>user_d4p4k80030</password><email>435c4660-6945-41cd-9025-23a763e44f22@localhost</email></query></iq>

2019-11-25 21:00:42 | StanzaSendingEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@78d2ad60}

2019-11-25 21:00:42 | user :: null << <iq xmlns="jabber:client" type="result" id="raXcP36El29nWeUcKQPMDpZ" from="localhost"/>

2019-11-25 21:00:42 | StanzaReceivedEvent{stanza=tigase.jaxmpp.core.client.xmpp.stanzas.IQ@76c508b4}

2019-11-25 21:00:42 | [Mutex] received everything.

2019-11-25 21:00:42 | [Mutex] isItemNotified: registrationSuccess :: true

2019-11-25 21:00:42 | StateChangedEvent{oldState=connected, newState=disconnecting, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@15559457, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@28d5b3c2]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@34476123}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3078e373}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@757a6b18}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@4b043524}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:42 PST 2019}}}}

2019-11-25 21:00:42 | StateChangedEvent{oldState=disconnecting, newState=disconnected, sessionObject=AbstractSessionObject{properties={CONNECTOR#ENCRYPTED_KEY=Entry{scope=stream, value=true}, TRUST_MANAGERS_KEY=Entry{scope=user, value=[Ljavax.net.ssl.X509TrustManager;@321eba00}, CONNECTOR#DISABLEKEEPALIVE=Entry{scope=stream, value=false}, StreamFeaturesModule#STREAMS_FEATURES_LIST=Entry{scope=session, value=[tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@15559457, tigase.jaxmpp.j2se.connectors.socket.SocketConnector$3@28d5b3c2]}, STREAMS_MANAGER_KEY=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.stream.XmppStreamsManager@34476123}, COMPRESSION_DISABLED=Entry{scope=user, value=true}, HOSTNAME_VERIFIER_KEY=Entry{scope=session, value=tigase.jaxmpp.j2se.connectors.socket.DefaultHostnameVerifier@5f8390f}, BOSH#SEE_OTHER_HOST_KEY=Entry{scope=user, value=false}, CONNECTOR#STAGE_KEY=Entry{scope=stream, value=disconnected}, RosterModule#ROSTER_STORE=Entry{scope=user, value=tigase.jaxmpp.core.client.xmpp.modules.roster.DefaultRosterStore@3078e373}, PresenceModule#PRESENCE_STORE=Entry{scope=user, value=tigase.jaxmpp.j2se.J2SEPresenceStore@757a6b18}, ResponseManager#RESPONSE_MANAGER=Entry{scope=user, value=tigase.jaxmpp.j2se.ThreadSafeResponseManager@4b043524}, StreamFeaturesModule#PIPELINING_ACTIVE=Entry{scope=session, value=false}, DEFAULT_XMPP_STREAM_KEY=Entry{scope=session, value=DefaultXMPPStream}, domainName=Entry{scope=user, value=localhost}, StreamFeaturesModule#EMBEDDED_STREAMS_COUNTER=Entry{scope=session, value=2}, LOG_PREFIX=Entry{scope=user, value=user}, socket#ServerHost=Entry{scope=user, value=localhost}, IN_BAND_REGISTRATION_MODE_KEY=Entry{scope=session, value=true}, CONNECTOR#CONNECTOR_STAGE_TIMESTAMP_KEY=Entry{scope=stream, value=Mon Nov 25 21:00:42 PST 2019}}}}

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@730bee0d

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.JaxmppCore$LoggedOutHandler$LoggedOutEvent@39b7f3ba

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.SessionObject$ClearedHandler$ClearedEvent@487f08db

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.Connector$StreamTerminatedHandler$StreamTerminatedEvent@16a129c8

2019-11-25 21:00:42 | tigase.jaxmpp.core.client.Connector$DisconnectedHandler$DisconnectedEvent@3a76d697

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2Q0cDRrODAwMzAscj11dXJTemxQZjB5SWJ5U0ZVSjFDWA==</auth>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj11dXJTemxQZjB5SWJ5U0ZVSjFDWE9OMEFRZEppVzF2clNUbWlTUkhnLHM9SlpSUkRuSXUvYjEzUEE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9dXVyU3psUGYweUlieVNGVUoxQ1hPTjBBUWRKaVcxdnJTVG1pU1JIZyxwPWVLN2JiRC8xUGY2ak50Yllsc0xEckwwbUU0TVpocEt4cWpPSzk0UFpsWHM9</response>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <success xmlns="urn:ietf:params:xml:ns:xmpp-sasl">dj1VLzNkMHRHKzd3L0NnTGJaeDV4RVNiYzZyQWhpZ3kycWIyQ2JSd0NWQmhRPQ==</success>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><register xmlns="http://jabber.org/features/iq-register"/><csi xmlns="urn:xmpp:csi:0"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><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"><optional/></session><c hash="SHA-1" node="https://tigase.net/tigase-xmpp-server" xmlns="http://jabber.org/protocol/caps" ver="bt2mj6vq9J3s6VE0/7D8Mo0TIoU="/></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <iq xmlns="jabber:client" id="vOR8jY17qcQ4ukNIv9tWiWn" type="set"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><resource/></bind></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <iq to="user_d4p4k80030@localhost/993927746-tigase-22" xmlns="jabber:client" type="result" id="vOR8jY17qcQ4ukNIv9tWiWn"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><jid>user_d4p4k80030@localhost/993927746-tigase-22</jid></bind></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 >> <iq xmlns="jabber:client" id="ncZfDxrcP36El29nWeUcKQP" type="set"><session xmlns="urn:ietf:params:xml:ns:xmpp-session"/></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 << <iq to="user_d4p4k80030@localhost/993927746-tigase-22" xmlns="jabber:client" type="result" id="ncZfDxrcP36El29nWeUcKQP"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 >> <iq to="localhost" id="GcX1apX5aKQbIENXdzpbGNZ" type="get"><query xmlns="http://jabber.org/protocol/disco#info"/></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 >> <enable xmlns="urn:xmpp:sm:3" resume="true"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 << <enabled resume="true" max="60" xmlns="urn:xmpp:sm:3" location="d4270859fb27" id="46905d7f-b174-465a-a1a8-8f10fc1fa20e"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 >> <iq id="ne1jLNXeTbman6hDsgYk0mR" type="get"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 >> <presence><c xmlns="http://jabber.org/protocol/caps" node="http://tigase.org/jaxmpp" ver="mg5bXbOeu1848vxdgu3jELgbQF8=" hash="sha-1"/></presence>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 << <iq to="user_d4p4k80030@localhost/993927746-tigase-22" xmlns="jabber:client" type="result" id="GcX1apX5aKQbIENXdzpbGNZ" from="localhost"><query xmlns="http://jabber.org/protocol/disco#info"><identity type="router" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="component"/><identity type="im" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="server"/><feature var="http://jabber.org/protocol/commands"/><x xmlns="jabber:x:data" type="result"><field type="hidden" var="FORM_TYPE"><value>http://jabber.org/network/serverinfo</value></field><field type="text-multi" var="abuse-addresses"><value>mailto:abuse@localhost</value><value>xmpp:abuse@localhost</value></field></x><feature var="urn:xmpp:carbons:2"/><feature var="http://jabber.org/protocol/stats"/><feature var="http://jabber.org/protocol/amp"/><feature var="msgoffline"/><feature var="vcard-temp"/><feature var="jabber:iq:auth"/><feature var="http://jabber.org/protocol/disco#info"/><feature var="http://jabber.org/protocol/disco#items"/><feature var="urn:xmpp:blocking"/><feature var="urn:xmpp:ping"/><feature var="urn:ietf:params:xml:ns:xmpp-sasl"/><feature var="http://jabber.org/protocol/pubsub"/><feature var="http://jabber.org/protocol/pubsub#owner"/><feature var="http://jabber.org/protocol/pubsub#publish"/><identity type="pep" category="pubsub"/><feature var="urn:xmpp:pep-vcard-conversion:0"/><feature var="urn:xmpp:bookmarks-conversion:0"/><feature var="urn:xmpp:archive:auto"/><feature var="urn:xmpp:archive:manage"/><feature var="urn:xmpp:push:0"/><feature var="tigase:push:away:0"/><feature var="tigase:push:encrypt:0"/><feature var="tigase:push:ignore-unknown:0"/><feature var="tigase:push:muc:0"/><feature var="tigase:push:priority:0"/><feature var="tigase:push:muted:0"/><feature var="jabber:iq:roster"/><feature var="jabber:iq:roster-dynamic"/><feature var="urn:xmpp:mam:1"/><feature var="jabber:iq:version"/><feature var="urn:xmpp:time"/><feature var="jabber:iq:privacy"/><feature var="urn:ietf:params:xml:ns:xmpp-bind"/><feature var="http://jabber.org/protocol/commands"/><feature var="urn:ietf:params:xml:ns:vcard-4.0"/><feature var="jabber:iq:private"/><feature var="urn:ietf:params:xml:ns:xmpp-session"/></query></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 << <iq to="user_d4p4k80030@localhost/993927746-tigase-22" xmlns="jabber:client" type="result" id="ne1jLNXeTbman6hDsgYk0mR"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:42 | Disconnecting

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-22 << <presence to="user_d4p4k80030@localhost" xmlns="jabber:client" from="user_d4p4k80030@localhost/993927746-tigase-22"><c hash="sha-1" node="http://tigase.org/jaxmpp" xmlns="http://jabber.org/protocol/caps" ver="mg5bXbOeu1848vxdgu3jELgbQF8="/></presence>

2019-11-25 21:00:42 | [Mutex] notify: [disconnected]

2019-11-25 21:00:42 | [Mutex] received everything.

2019-11-25 21:00:42 | [Mutex] waiting for: [event]

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2Q0cDRrODAwMzAscj1TM1kxZ1YxeUNSQ20zdkNqbGkxbA==</auth>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1TM1kxZ1YxeUNSQ20zdkNqbGkxbHZqY0tONUhIZVppanF5UkRkWFhHLHM9SlpSUkRuSXUvYjEzUEE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9UzNZMWdWMXlDUkNtM3ZDamxpMWx2amNLTjVISGVaaWpxeVJEZFhYRyxwPWhOWmFuTU11RzdoaG84d1hXU1ZBNS95ZEk2bzN4L1lWeXMrdXFnZGtLQkE9</response>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:42 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:42 | [Mutex] received everything.

2019-11-25 21:00:42 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:42 | [Mutex] waiting for: [event]

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2Q0cDRrODAwMzAscj1MczF4NHNmVmNsaGdpSlBCVXkwcQ==</auth>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1MczF4NHNmVmNsaGdpSlBCVXkwcWxvaWFiS09QMFdsZEhqOHhqTTQ5LHM9SlpSUkRuSXUvYjEzUEE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9THMxeDRzZlZjbGhnaUpQQlV5MHFsb2lhYktPUDBXbGRIajh4ak00OSxwPTlHak9QR3paNkhjc3EwcTZXQlZhN1EyRnZDL2VVMEU0RXVSMlRsQnJtMms9</response>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:42 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:42 | [Mutex] received everything.

2019-11-25 21:00:42 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:42 | [Mutex] waiting for: [event]

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2Q0cDRrODAwMzAscj1OUXFQOUVlajNKN3VJTDNJZDd1Tw==</auth>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1OUXFQOUVlajNKN3VJTDNJZDd1T2NjcnRBcW5CUjAyZlc2Um5KR0RSLHM9SlpSUkRuSXUvYjEzUEE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9TlFxUDlFZWozSjd1SUwzSWQ3dU9jY3J0QXFuQlIwMmZXNlJuSkdEUixwPTJiY3h6OWFEV2hVMGdSOFdPUlpVenN5a3VvMm5KNjIwek1GYkNkMTFUYXc9</response>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <failure xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><not-authorized/><text xml:lang="en">Password not verified</text></failure>

2019-11-25 21:00:42 | [Mutex] notify: [event, authFailed]

2019-11-25 21:00:42 | [Mutex] received everything.

2019-11-25 21:00:42 | [Mutex] isItemNotified: authFailed :: true

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"/><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"><required/></starttls><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <starttls xmlns="urn:ietf:params:xml:ns:xmpp-tls"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><auth xmlns="http://jabber.org/features/iq-auth"/><mechanisms xmlns="urn:ietf:params:xml:ns:xmpp-sasl"><mechanism>SCRAM-SHA-256</mechanism><mechanism>SCRAM-SHA-1</mechanism><mechanism>PLAIN</mechanism><mechanism>ANONYMOUS</mechanism></mechanisms><register xmlns="http://jabber.org/features/iq-register"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><compression xmlns="http://jabber.org/features/compress"><method>zlib</method></compression></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <auth xmlns="urn:ietf:params:xml:ns:xmpp-sasl" mechanism="SCRAM-SHA-256">biwsbj11c2VyX2Q0cDRrODAwMzAscj1CRjZtVWxVS1dxNDduZXVGemNnZg==</auth>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <challenge xmlns="urn:ietf:params:xml:ns:xmpp-sasl">cj1CRjZtVWxVS1dxNDduZXVGemNnZkJCcVJUOGdqN1ZHQUp4MmQzM1dBLHM9SlpSUkRuSXUvYjEzUEE9PSxpPTQwOTY=</challenge>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <response xmlns="urn:ietf:params:xml:ns:xmpp-sasl">Yz1iaXdzLHI9QkY2bVVsVUtXcTQ3bmV1RnpjZ2ZCQnFSVDhnajdWR0FKeDJkMzNXQSxwPUxDY2ppQjViSmphdWp4ZEpuZUt1MEo3OEY0NmFUakkrMU9wK3VYVDZKV1E9</response>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <success xmlns="urn:ietf:params:xml:ns:xmpp-sasl">dj00QkVHVW1JcnZSYUFvNkk4eFJNTndNSHRvVFFwMEVORFljcHdUM0dqQ0VBPQ==</success>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <features xmlns="http://etherx.jabber.org/streams"><sm xmlns="urn:xmpp:sm:3"/><register xmlns="http://jabber.org/features/iq-register"/><csi xmlns="urn:xmpp:csi:0"/><ver xmlns="urn:xmpp:features:rosterver"/><sub xmlns="urn:xmpp:features:pre-approval"/><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"><optional/></session><c hash="SHA-1" node="https://tigase.net/tigase-xmpp-server" xmlns="http://jabber.org/protocol/caps" ver="bt2mj6vq9J3s6VE0/7D8Mo0TIoU="/></features>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost >> <iq xmlns="jabber:client" id="mnqbFtdNUfTM03sZ3iWk2qc" type="set"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><resource/></bind></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost << <iq to="user_d4p4k80030@localhost/993927746-tigase-23" xmlns="jabber:client" type="result" id="mnqbFtdNUfTM03sZ3iWk2qc"><bind xmlns="urn:ietf:params:xml:ns:xmpp-bind"><jid>user_d4p4k80030@localhost/993927746-tigase-23</jid></bind></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 >> <iq xmlns="jabber:client" id="V2nZl0rhyy9EnPQ2wqcKDoR" type="set"><session xmlns="urn:ietf:params:xml:ns:xmpp-session"/></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 << <iq to="user_d4p4k80030@localhost/993927746-tigase-23" xmlns="jabber:client" type="result" id="V2nZl0rhyy9EnPQ2wqcKDoR"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 >> <iq to="localhost" id="Xh4qhXUgzu3bysm6ys3exdB" type="get"><query xmlns="http://jabber.org/protocol/disco#info"/></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 >> <enable xmlns="urn:xmpp:sm:3" resume="true"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 << <enabled resume="true" max="60" xmlns="urn:xmpp:sm:3" location="d4270859fb27" id="a7af99d7-091b-4b10-ae80-7e43c01fa8f0"/>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 >> <iq id="Gh2bu3fFk4utiO7Bv9zvk5z" type="get"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 >> <presence><c xmlns="http://jabber.org/protocol/caps" node="http://tigase.org/jaxmpp" ver="mg5bXbOeu1848vxdgu3jELgbQF8=" hash="sha-1"/></presence>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 << <iq to="user_d4p4k80030@localhost/993927746-tigase-23" xmlns="jabber:client" type="result" id="Xh4qhXUgzu3bysm6ys3exdB" from="localhost"><query xmlns="http://jabber.org/protocol/disco#info"><identity type="router" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="component"/><identity type="im" name="Tigase ver. 8.1.0-SNAPSHOT-b10580/f55efd39" category="server"/><feature var="http://jabber.org/protocol/commands"/><x xmlns="jabber:x:data" type="result"><field type="hidden" var="FORM_TYPE"><value>http://jabber.org/network/serverinfo</value></field><field type="text-multi" var="abuse-addresses"><value>mailto:abuse@localhost</value><value>xmpp:abuse@localhost</value></field></x><feature var="urn:xmpp:carbons:2"/><feature var="http://jabber.org/protocol/stats"/><feature var="http://jabber.org/protocol/amp"/><feature var="msgoffline"/><feature var="vcard-temp"/><feature var="jabber:iq:auth"/><feature var="http://jabber.org/protocol/disco#info"/><feature var="http://jabber.org/protocol/disco#items"/><feature var="urn:xmpp:blocking"/><feature var="urn:xmpp:ping"/><feature var="urn:ietf:params:xml:ns:xmpp-sasl"/><feature var="http://jabber.org/protocol/pubsub"/><feature var="http://jabber.org/protocol/pubsub#owner"/><feature var="http://jabber.org/protocol/pubsub#publish"/><identity type="pep" category="pubsub"/><feature var="urn:xmpp:pep-vcard-conversion:0"/><feature var="urn:xmpp:bookmarks-conversion:0"/><feature var="urn:xmpp:archive:auto"/><feature var="urn:xmpp:archive:manage"/><feature var="urn:xmpp:push:0"/><feature var="tigase:push:away:0"/><feature var="tigase:push:encrypt:0"/><feature var="tigase:push:ignore-unknown:0"/><feature var="tigase:push:muc:0"/><feature var="tigase:push:priority:0"/><feature var="tigase:push:muted:0"/><feature var="jabber:iq:roster"/><feature var="jabber:iq:roster-dynamic"/><feature var="urn:xmpp:mam:1"/><feature var="jabber:iq:version"/><feature var="urn:xmpp:time"/><feature var="jabber:iq:privacy"/><feature var="urn:ietf:params:xml:ns:xmpp-bind"/><feature var="http://jabber.org/protocol/commands"/><feature var="urn:ietf:params:xml:ns:vcard-4.0"/><feature var="jabber:iq:private"/><feature var="urn:ietf:params:xml:ns:xmpp-session"/></query></iq>

2019-11-25 21:00:42 | user :: user_d4p4k80030@localhost/993927746-tigase-23 << <iq to="user_d4p4k80030@localhost/993927746-tigase-23" xmlns="jabber:client" type="result" id="Gh2bu3fFk4utiO7Bv9zvk5z"><query xmlns="jabber:iq:roster"/></iq>

2019-11-25 21:00:43 | Disconnecting

2019-11-25 21:00:43 | user :: user_d4p4k80030@localhost/993927746-tigase-23 << <presence to="user_d4p4k80030@localhost" xmlns="jabber:client" from="user_d4p4k80030@localhost/993927746-tigase-23"><c hash="sha-1" node="http://tigase.org/jaxmpp" xmlns="http://jabber.org/protocol/caps" ver="mg5bXbOeu1848vxdgu3jELgbQF8="/></presence>

2019-11-25 21:00:43 | [Mutex] notify: [disconnected]

2019-11-25 21:00:43 | [Mutex] received everything.

2019-11-25 21:00:45 | [Mutex] waiting for: [user]

2019-11-25 21:00:45 | [Mutex] received everything.

2019-11-25 21:00:45 | [Mutex] isItemNotified: user:ok:true :: true