=== Test case: rest_SUITE:befriend_and_alienate_auto/1 (click for source code)
=== Config value:
[{watchdog,<0.12831.1>},
{{ejabberd_cwd,mongooseim@localhost},
"/home/circleci/project/_build/mim1/rel/mongooseim"},
{mam_backend,disabled},
{mim_data_dir,"/home/circleci/project/big_tests/tests/rest_SUITE_data"},
{preset,"ldap_mnesia"},
{tc_logfile,"/home/circleci/project/big_tests/ct_report/ct_run.test@d66972e2ee88.2022-01-27_15.24.27/big_tests.tests.rest_SUITE.logs/run.2022-01-27_15.33.42/rest_suite.befriend_and_alienate_auto.72322.html"},
{tc_group_properties,[{name,roster},parallel]},
{tc_group_path,[]},
{data_dir,"/home/circleci/project/big_tests/_build/default/lib/mongoose_tests/ebin/rest_SUITE_data/"},
{priv_dir,"/home/circleci/project/big_tests/ct_report/ct_run.test@d66972e2ee88.2022-01-27_15.24.27/big_tests.tests.rest_SUITE.logs/run.2022-01-27_15.33.42/log_private/"},
{escalus_users,[{alice,[{username,<<"alicE">>},
{server,<<"localhost">>},
{password,<<"matygrysa">>}]},
{bob,[{username,<<"bOb">>},
{server,<<"localhost">>},
{password,<<"makrolika">>}]}]}]
=== Current directory is "/home/circleci/project/big_tests/ct_report/ct_run.test@d66972e2ee88.2022-01-27_15.24.27"
=== Started at 2022-01-27 15:33:43
*** User 2022-01-27 15:33:43.892 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 out
<stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-01-27 15:33:43.892 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='1b5081f158fe441e' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-01-27 15:33:43.892 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:features>
<starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/>
<compression xmlns='http://jabber.org/features/compress'>
<method>zlib</method>
</compression>
<mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'>
<mechanism>PLAIN</mechanism>
</mechanisms>
<register xmlns='http://jabber.org/features/iq-register'/>
<amp xmlns='http://jabber.org/feature/amp'/>
<sm xmlns='urn:xmpp:sm:3'/>
</stream:features>
*** User 2022-01-27 15:33:43.892 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 out
<auth xmlns='urn:ietf:params:xml:ns:xmpp-sasl' mechanism='PLAIN'>AGFsaWNFX2JlZnJpZW5kX2FuZF9hbGllbmF0ZV9hdXRvXzExMDgAbWF0eWdyeXNh</auth>
*** User 2022-01-27 15:33:43.893 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<success xmlns='urn:ietf:params:xml:ns:xmpp-sasl'/>
*** User 2022-01-27 15:33:43.893 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 out
<stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-01-27 15:33:43.894 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='0a88c4d85fb187b5' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-01-27 15:33:43.894 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:features>
<compression xmlns='http://jabber.org/features/compress'>
<method>zlib</method>
</compression>
<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'/>
<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
<register xmlns='http://jabber.org/features/iq-register'/>
<amp xmlns='http://jabber.org/feature/amp'/>
<sm xmlns='urn:xmpp:sm:3'/>
</stream:features>
*** User 2022-01-27 15:33:43.894 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 out
<iq type='set' id='6d48b7c90f1e803d6ba9c2c1d07acec1'>
<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
<resource>res1</resource>
</bind>
</iq>
*** User 2022-01-27 15:33:43.894 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq id='6d48b7c90f1e803d6ba9c2c1d07acec1' type='result'>
<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
<jid>alicE_befriend_and_alienate_auto_1108@localhost/res1</jid>
</bind>
</iq>
*** User 2022-01-27 15:33:43.895 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 out
<iq type='set' id='9fb3f43f033bf7610705d78993593e20'>
<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>
*** User 2022-01-27 15:33:43.895 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq type='result' id='9fb3f43f033bf7610705d78993593e20'>
<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>
*** User 2022-01-27 15:33:43.895 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 out
<presence/>
*** User 2022-01-27 15:33:43.897 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='alicE_befriend_and_alienate_auto_1108@localhost/res1' to='alice_befriend_and_alienate_auto_1108@localhost/res1' xml:lang='en'/>
*** User 2022-01-27 15:33:43.898 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 out
<stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-01-27 15:33:43.898 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='38818719845e6213' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-01-27 15:33:43.898 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:features>
<starttls xmlns='urn:ietf:params:xml:ns:xmpp-tls'/>
<compression xmlns='http://jabber.org/features/compress'>
<method>zlib</method>
</compression>
<mechanisms xmlns='urn:ietf:params:xml:ns:xmpp-sasl'>
<mechanism>PLAIN</mechanism>
</mechanisms>
<register xmlns='http://jabber.org/features/iq-register'/>
<amp xmlns='http://jabber.org/feature/amp'/>
<sm xmlns='urn:xmpp:sm:3'/>
</stream:features>
*** User 2022-01-27 15:33:43.898 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 out
<auth xmlns='urn:ietf:params:xml:ns:xmpp-sasl' mechanism='PLAIN'>AGJPYl9iZWZyaWVuZF9hbmRfYWxpZW5hdGVfYXV0b18xMTA4AG1ha3JvbGlrYQ==</auth>
*** User 2022-01-27 15:33:43.899 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<success xmlns='urn:ietf:params:xml:ns:xmpp-sasl'/>
*** User 2022-01-27 15:33:43.899 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 out
<stream:stream to='localhost' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>
*** User 2022-01-27 15:33:43.900 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='0db834cb4f8f954c' from='localhost' version='1.0' xml:lang='en'>
*** User 2022-01-27 15:33:43.900 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<stream:features>
<compression xmlns='http://jabber.org/features/compress'>
<method>zlib</method>
</compression>
<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'/>
<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
<register xmlns='http://jabber.org/features/iq-register'/>
<amp xmlns='http://jabber.org/feature/amp'/>
<sm xmlns='urn:xmpp:sm:3'/>
</stream:features>
*** User 2022-01-27 15:33:43.900 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 out
<iq type='set' id='ec018ae3fd7af59c2cf5e3511787b437'>
<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
<resource>res1</resource>
</bind>
</iq>
*** User 2022-01-27 15:33:43.900 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq id='ec018ae3fd7af59c2cf5e3511787b437' type='result'>
<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
<jid>bOb_befriend_and_alienate_auto_1108@localhost/res1</jid>
</bind>
</iq>
*** User 2022-01-27 15:33:43.900 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 out
<iq type='set' id='9f4818e34df49cdf3a91f94f21e746b1'>
<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>
*** User 2022-01-27 15:33:43.900 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq type='result' id='9f4818e34df49cdf3a91f94f21e746b1'>
<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>
*** User 2022-01-27 15:33:43.901 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 out
<presence/>
*** User 2022-01-27 15:33:43.901 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='bOb_befriend_and_alienate_auto_1108@localhost/res1' to='bob_befriend_and_alienate_auto_1108@localhost/res1' xml:lang='en'/>
*** User 2022-01-27 15:33:43.903 ***
REST request:
Code: 200
Req: {<0.12886.1>,
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost">>,
<<"GET">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"3e1ed8cce091d149">>}],
<<>>}
Result: {{<<"200">>,<<"OK">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>},
{<<"content-length">>,<<"2">>}],
<<"[]">>,125,959}
Params: #{body => <<>>,method => <<"GET">>,
path =>
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.905 ***
REST request:
Code: 200
Req: {<0.12894.1>,
<<"/api/contacts/bob_befriend_and_alienate_auto_1108@localhost">>,
<<"GET">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"e917e67c6defe776">>}],
<<>>}
Result: {{<<"200">>,<<"OK">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>},
{<<"content-length">>,<<"2">>}],
<<"[]">>,125,479}
Params: #{body => <<>>,method => <<"GET">>,
path =>
<<"/api/contacts/bob_befriend_and_alienate_auto_1108@localhost">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.912 ***
REST request:
Code: 204
Req: {<0.12903.1>,
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost/bob_befriend_and_alienate_auto_1108@localhost/manage">>,
<<"PUT">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"3a557d64915be8cb">>}],
<<"{\"action\":\"connect\"}">>}
Result: {{<<"204">>,<<"No Content">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>}],
<<>>,112,6453}
Params: #{body => <<"{\"action\":\"connect\"}">>,method => <<"PUT">>,
path =>
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost/bob_befriend_and_alienate_auto_1108@localhost/manage">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.914 ***
REST request:
Code: 200
Req: {<0.12926.1>,
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost">>,
<<"GET">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"35787438228c45ff">>}],
<<>>}
Result: {{<<"200">>,<<"OK">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>},
{<<"content-length">>,<<"92">>}],
<<"[{\"subscription\":\"both\",\"jid\":\"bob_befriend_and_alienate_auto_1108@localhost\",\"ask\":\"none\"}]">>,
216,464}
Params: #{body => <<>>,method => <<"GET">>,
path =>
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.915 ***
REST request:
Code: 200
Req: {<0.12930.1>,
<<"/api/contacts/bob_befriend_and_alienate_auto_1108@localhost">>,
<<"GET">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"dcf77b69141d3c05">>}],
<<>>}
Result: {{<<"200">>,<<"OK">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>},
{<<"content-length">>,<<"94">>}],
<<"[{\"subscription\":\"both\",\"jid\":\"alice_befriend_and_alienate_auto_1108@localhost\",\"ask\":\"none\"}]">>,
218,621}
Params: #{body => <<>>,method => <<"GET">>,
path =>
<<"/api/contacts/bob_befriend_and_alienate_auto_1108@localhost">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.919 ***
REST request:
Code: 204
Req: {<0.12936.1>,
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost/bob_befriend_and_alienate_auto_1108@localhost/manage">>,
<<"PUT">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"2c7d0038382000fd">>}],
<<"{\"action\":\"disconnect\"}">>}
Result: {{<<"204">>,<<"No Content">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>}],
<<>>,112,3505}
Params: #{body => <<"{\"action\":\"disconnect\"}">>,method => <<"PUT">>,
path =>
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost/bob_befriend_and_alienate_auto_1108@localhost/manage">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.920 ***
REST request:
Code: 200
Req: {<0.12948.1>,
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost">>,
<<"GET">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"4809eedab99b686b">>}],
<<>>}
Result: {{<<"200">>,<<"OK">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>},
{<<"content-length">>,<<"2">>}],
<<"[]">>,125,420}
Params: #{body => <<>>,method => <<"GET">>,
path =>
<<"/api/contacts/alice_befriend_and_alienate_auto_1108@localhost">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.922 ***
REST request:
Code: 200
Req: {<0.12955.1>,
<<"/api/contacts/bob_befriend_and_alienate_auto_1108@localhost">>,
<<"GET">>,
[{<<"Content-Type">>,<<"application/json">>},
{<<"Request-Id">>,<<"129b807d73e43c32">>}],
<<>>}
Result: {{<<"200">>,<<"OK">>},
[{<<"server">>,<<"Cowboy">>},
{<<"date">>,<<"Thu, 27 Jan 2022 15:33:43 GMT">>},
{<<"content-type">>,<<"application/json">>},
{<<"content-length">>,<<"2">>}],
<<"[]">>,125,494}
Params: #{body => <<>>,method => <<"GET">>,
path =>
<<"/api/contacts/bob_befriend_and_alienate_auto_1108@localhost">>,
return_headers => true,role => admin,
server => #{node => mongooseim@localhost}}
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='alice_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' id='push18d58ebadd74aa60' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='none' jid='bob_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='alice_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' id='push885525ea13aaee40' type='set'>
<query xmlns='jabber:iq:roster'>
<item ask='subscribe' subscription='none' jid='bob_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='alice_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' id='push7b8afe00858490cd' type='set'>
<query xmlns='jabber:iq:roster'>
<item ask='subscribe' subscription='none' jid='bob_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='bob_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' type='subscribe'/>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='bOb_befriend_and_alienate_auto_1108@localhost/res1' to='alice_befriend_and_alienate_auto_1108@localhost/res1' xml:lang='en'/>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='alice_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' id='push8cba7fbcf5b4bd7f' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='to' jid='bob_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='bob_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' type='subscribed'/>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='alice_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' id='push47a0e560d86312e8' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='both' jid='bob_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:43.922 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='alice_befriend_and_alienate_auto_1108@localhost' to='alice_befriend_and_alienate_auto_1108@localhost/res1' id='push1f9468d0a3bbe850' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='remove' jid='bob_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:43.923 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='bOb_befriend_and_alienate_auto_1108@localhost/res1' to='alice_befriend_and_alienate_auto_1108@localhost/res1' type='unavailable'/>
*** User 2022-01-27 15:33:48.923 ***
APushes: [{xmlel,<<"iq">>,
[{<<"from">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"alice_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push18d58ebadd74aa60">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"none">>},
{<<"jid">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"alice_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push885525ea13aaee40">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"ask">>,<<"subscribe">>},
{<<"subscription">>,<<"none">>},
{<<"jid">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"alice_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push7b8afe00858490cd">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"ask">>,<<"subscribe">>},
{<<"subscription">>,<<"none">>},
{<<"jid">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"alice_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push8cba7fbcf5b4bd7f">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"to">>},
{<<"jid">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"alice_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push47a0e560d86312e8">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"both">>},
{<<"jid">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"alice_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push1f9468d0a3bbe850">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"remove">>},
{<<"jid">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]}]
*** User 2022-01-27 15:33:48.923 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='bob_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' id='push98cda2bb5fa5accf' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='none' jid='alice_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:48.923 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='alice_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' type='subscribe'/>
*** User 2022-01-27 15:33:48.923 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='bob_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' id='pusha020823310b14db4' type='set'>
<query xmlns='jabber:iq:roster'>
<item ask='subscribe' subscription='none' jid='alice_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:48.923 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='bob_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' id='pushea960e2f811b0ea1' type='set'>
<query xmlns='jabber:iq:roster'>
<item ask='subscribe' subscription='from' jid='alice_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='alicE_befriend_and_alienate_auto_1108@localhost/res1' to='bob_befriend_and_alienate_auto_1108@localhost/res1' xml:lang='en'/>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='bob_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' id='push536b0a24f24f2d95' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='both' jid='alice_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='alice_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' type='subscribed'/>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='alicE_befriend_and_alienate_auto_1108@localhost/res1' to='bob_befriend_and_alienate_auto_1108@localhost/res1' type='unavailable'/>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='bob_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' id='push7697aa92b034cfc9' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='to' jid='alice_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='alice_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' type='unsubscribe'/>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='bob_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' id='push7930a46d79813f39' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='none' jid='alice_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<presence from='alice_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' type='unsubscribed'/>
*** User 2022-01-27 15:33:48.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
<iq from='bob_befriend_and_alienate_auto_1108@localhost' to='bob_befriend_and_alienate_auto_1108@localhost/res1' id='push91b5dd89d45edbb7' type='set'>
<query xmlns='jabber:iq:roster'>
<item subscription='remove' jid='alice_befriend_and_alienate_auto_1108@localhost'/>
</query>
</iq>
*** User 2022-01-27 15:33:53.924 ***
BPushes: [{xmlel,<<"iq">>,
[{<<"from">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"bob_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push98cda2bb5fa5accf">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"none">>},
{<<"jid">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"bob_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"pusha020823310b14db4">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"ask">>,<<"subscribe">>},
{<<"subscription">>,<<"none">>},
{<<"jid">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"bob_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"pushea960e2f811b0ea1">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"ask">>,<<"subscribe">>},
{<<"subscription">>,<<"from">>},
{<<"jid">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"bob_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push536b0a24f24f2d95">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"both">>},
{<<"jid">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"bob_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push7697aa92b034cfc9">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"to">>},
{<<"jid">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"bob_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push7930a46d79813f39">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"none">>},
{<<"jid">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]},
{xmlel,<<"iq">>,
[{<<"from">>,
<<"bob_befriend_and_alienate_auto_1108@localhost">>},
{<<"to">>,
<<"bob_befriend_and_alienate_auto_1108@localhost/res1">>},
{<<"id">>,<<"push91b5dd89d45edbb7">>},
{<<"type">>,<<"set">>}],
[{xmlel,<<"query">>,
[{<<"xmlns">>,<<"jabber:iq:roster">>}],
[{xmlel,<<"item">>,
[{<<"subscription">>,<<"remove">>},
{<<"jid">>,
<<"alice_befriend_and_alienate_auto_1108@localhost">>}],
[]}]}]}]
*** User 2022-01-27 15:33:53.924 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 out
</stream:stream>
*** User 2022-01-27 15:33:53.925 ***
bOb_befriend_and_alienate_auto_1108@localhost/res1 in
</stream:stream>
*** User 2022-01-27 15:33:53.925 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 out
</stream:stream>
*** User 2022-01-27 15:33:53.925 ***
alicE_befriend_and_alienate_auto_1108@localhost/res1 in
</stream:stream>
=== Ended at 2022-01-27 15:33:53
=== successfully completed test case
=== === Returned value: ok