=== Test case: mam_SUITE:messages_filtered_when_prefs_default_policy_is_roster/1 (click for source code)

=== Config value:

    [{basic_group,prefs_cases},
     {configuration,rdbms_mnesia_cache},
     {mam_meta_opts,#{archive_chat_markers => false,
                      async_writer =>
                          #{batch_size => 30,enabled => false,
                            flush_interval => 2000,pool_size => 16},
                      backend => rdbms,
                      cache =>
                          #{module => internal,number_of_segments => 3,
                            strategy => fifo,time_to_live => 480},
                      cache_users => true,default_result_limit => 50,
                      full_text_search => true,
                      is_archivable_message => mod_mam_utils,
                      max_result_limit => 50,message_retraction => true,
                      no_stanzaid_element => false,
                      pm =>
                          #{archive_groupchats => false,
                            same_mam_id_for_peers => false},
                      send_message => mod_mam_utils,
                      user_prefs_store => mnesia}},
     {watchdog,<0.16940.1>},
     {mod_offline_loaded,false},
     {escalus_user_db,{module,escalus_ejabberd}},
     {mim_data_dir,"/home/circleci/project/big_tests/tests/mam_SUITE_data"},
     {preset,"odbc_mssql_mnesia"},
     {tc_logfile,"/home/circleci/project/big_tests/ct_report/ct_run.test@f0b09cc3aef4.2022-05-25_09.03.38/big_tests.tests.mam_SUITE.logs/run.2022-05-25_09.08.32/mam_suite.messages_filtered_when_prefs_default_policy_is_roster.110850.html"},
     {tc_group_properties,[{name,rdbms_mnesia_cache_prefs_cases},parallel]},
     {tc_group_path,[]},
     {data_dir,"/home/circleci/project/big_tests/_build/default/lib/mongoose_tests/ebin/mam_SUITE_data/"},
     {priv_dir,"/home/circleci/project/big_tests/ct_report/ct_run.test@f0b09cc3aef4.2022-05-25_09.03.38/big_tests.tests.mam_SUITE.logs/run.2022-05-25_09.08.32/log_private/"},
     {config_backup,#{[shaper,fast] => {ok,#{max_rate => 50000}},
                      [shaper,mam_shaper] => {ok,#{max_rate => 1}},
                      [shaper,normal] => {ok,#{max_rate => 1000}},
                      [{access,<<"test type">>},max_user_sessions] =>
                          {ok,[#{acl => all,value => 10}]}}},
     {{saved_modules,mongooseim@localhost,<<"test type">>},
      #{mod_adhoc => #{iqdisc => one_queue,report_commands_node => false},
        mod_amp => #{},
        mod_bosh =>
            #{backend => mnesia,inactivity => 30,max_pause => 120,
              max_wait => infinity,server_acks => false},
        mod_cache_users =>
            #{number_of_segments => 5,strategy => fifo,time_to_live => 2},
        mod_carboncopy => #{iqdisc => no_queue},
        mod_commands => #{},
        mod_disco =>
            #{extra_domains => [],iqdisc => one_queue,server_info => [],
              users_can_see_hidden_services => false},
        mod_muc =>
            #{access => muc,access_admin => none,access_create => muc_create,
              access_persistent => all,backend => rdbms,
              default_room =>
                  #{affiliations => [],allow_change_subj => true,
                    allow_multiple_sessions => false,
                    allow_private_messages => true,allow_query_users => true,
                    allow_user_invites => false,
                    allow_visitor_nickchange => true,
                    allow_visitor_status => true,anonymous => true,
                    description => <<>>,logging => false,max_users => 200,
                    maygetmemberlist => [],members_by_default => true,
                    members_only => false,moderated => true,password => <<>>,
                    password_protected => false,persistent => false,
                    public => true,public_list => true,subject => <<>>,
                    subject_author => <<>>,title => <<>>},
              hibernate_timeout => 2000,
              hibernated_room_check_interval => 1000,
              hibernated_room_timeout => 2000,history_size => 20,
              host => {prefix,<<"groupchats.">>},
              http_auth_pool => none,load_permanent_rooms_at_startup => false,
              max_room_desc => infinity,max_room_id => infinity,
              max_room_name => infinity,max_user_conferences => 10,
              max_users => 200,max_users_admin_threshold => 5,
              min_message_interval => 0,min_presence_interval => 0,
              room_shaper => none,user_message_shaper => none,
              user_presence_shaper => none},
        mod_muc_commands => #{},mod_muc_light_commands => #{},
        mod_muc_log =>
            #{access_log => muc,css_file => false,dirname => room_jid,
              dirtype => subdirs,file_format => html,outdir => "/tmp/muclogs",
              spam_prevention => true,timezone => local,
              top_link => {"/","Home"}},
        mod_register =>
            #{access => register,
              ip_access => [{allow,"127.0.0.0/8"},{deny,"0.0.0.0/0"}],
              iqdisc => one_queue,password_strength => 0,
              registration_watchers => []},
        mod_roster =>
            #{backend => rdbms,iqdisc => one_queue,store_current_id => false,
              versioning => false},
        mod_sic => #{iqdisc => one_queue},
        mod_stream_management =>
            #{ack => true,ack_freq => 1,backend => mnesia,buffer => true,
              buffer_max => 100,resume_timeout => 600,
              stale_h =>
                  #{enabled => false,geriatric => 3600,repeat_after => 1800}},
        mod_vcard =>
            #{backend => rdbms,
              host => {prefix,<<"vjud.">>},
              iqdisc => parallel,matches => 30,search => true}}},
     {escalus_users,[{alice,[{username,<<"alicE">>},
                             {server,<<"domain.example.com">>},
                             {host,<<"localhost">>},
                             {password,<<"matygrysa">>}]},
                     {bob,[{username,<<"bOb">>},
                           {server,<<"domain.example.com">>},
                           {host,<<"localhost">>},
                           {password,<<"makrolika">>}]},
                     {kate,[{username,<<"kate">>},
                            {server,<<"domain.example.com">>},
                            {host,<<"localhost">>},
                            {password,<<"makrowe;p">>}]},
                     {carol,[{username,<<"carol">>},
                             {server,<<"domain.example.com">>},
                             {host,<<"localhost">>},
                             {password,<<"jinglebells">>},
                             {transport,escalus_bosh},
                             {path,<<"/http-bind">>},
                             {port,5280}]}]}]

=== Current directory is "/home/circleci/project/big_tests/ct_report/ct_run.test@f0b09cc3aef4.2022-05-25_09.03.38"

=== Started at 2022-05-25 09:09:45


*** CT 2022-05-25 09:09:45.393 *** View log from node mongooseim@localhost when started mongooseim@localhost_1837.html
*** CT 2022-05-25 09:09:45.393 *** View log from node ejabberd2@localhost when started ejabberd2@localhost_424.html
Could not find element props in Config.


*** User 2022-05-25 09:09:45.423 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<stream:stream to='domain.example.com' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>

*** User 2022-05-25 09:09:45.423 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='ade116705d9e1e2f' from='domain.example.com' version='1.0' xml:lang='en'>

*** User 2022-05-25 09:09:45.423 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/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>SCRAM-SHA-256</mechanism>
		<mechanism>PLAIN</mechanism>
	</mechanisms>
	<register xmlns='http://jabber.org/features/iq-register'/>
	<amp xmlns='http://jabber.org/feature/amp'/>
	<sm xmlns='urn:xmpp:sm:3'/>
</stream:features>



*** User 2022-05-25 09:09:45.423 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<auth xmlns='urn:ietf:params:xml:ns:xmpp-sasl' mechanism='PLAIN'>AGFsaWNFX21lc3NhZ2VzX2ZpbHRlcmVkX3doZW5fcHJlZnNfZGVmYXVsdF9wb2xpY3lfaXNfcm9zdGVyXzE3MjYAbWF0eWdyeXNh</auth>



*** User 2022-05-25 09:09:45.426 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<success xmlns='urn:ietf:params:xml:ns:xmpp-sasl'/>



*** User 2022-05-25 09:09:45.426 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<stream:stream to='domain.example.com' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>

*** User 2022-05-25 09:09:45.426 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='2cd865ddd9605079' from='domain.example.com' version='1.0' xml:lang='en'>

*** User 2022-05-25 09:09:45.427 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/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-05-25 09:09:45.427 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='7c8e64463589d4dc01d600d2242355f3'>
	<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
		<resource>res1</resource>
	</bind>
</iq>



*** User 2022-05-25 09:09:45.427 ***
alicE_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq id='7c8e64463589d4dc01d600d2242355f3' type='result'>
	<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
		<jid>alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1</jid>
	</bind>
</iq>



*** User 2022-05-25 09:09:45.428 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='72bdfde82824635df474ac91748baf1a'>
	<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>



*** User 2022-05-25 09:09:45.428 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq type='result' id='72bdfde82824635df474ac91748baf1a'>
	<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>



*** User 2022-05-25 09:09:45.429 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<presence/>



*** User 2022-05-25 09:09:45.430 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en'/>



*** User 2022-05-25 09:09:45.432 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<stream:stream to='domain.example.com' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>

*** User 2022-05-25 09:09:45.432 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='a0a19b5d11691851' from='domain.example.com' version='1.0' xml:lang='en'>

*** User 2022-05-25 09:09:45.432 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/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>SCRAM-SHA-256</mechanism>
		<mechanism>PLAIN</mechanism>
	</mechanisms>
	<register xmlns='http://jabber.org/features/iq-register'/>
	<amp xmlns='http://jabber.org/feature/amp'/>
	<sm xmlns='urn:xmpp:sm:3'/>
</stream:features>



*** User 2022-05-25 09:09:45.433 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<auth xmlns='urn:ietf:params:xml:ns:xmpp-sasl' mechanism='PLAIN'>AGJPYl9tZXNzYWdlc19maWx0ZXJlZF93aGVuX3ByZWZzX2RlZmF1bHRfcG9saWN5X2lzX3Jvc3Rlcl8xNzI2AG1ha3JvbGlrYQ==</auth>



*** User 2022-05-25 09:09:45.435 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<success xmlns='urn:ietf:params:xml:ns:xmpp-sasl'/>



*** User 2022-05-25 09:09:45.435 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<stream:stream to='domain.example.com' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>

*** User 2022-05-25 09:09:45.435 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='5fc4c2c963f90235' from='domain.example.com' version='1.0' xml:lang='en'>

*** User 2022-05-25 09:09:45.435 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/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-05-25 09:09:45.435 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='71687eac06634b04cd8833ee703e61ce'>
	<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
		<resource>res1</resource>
	</bind>
</iq>



*** User 2022-05-25 09:09:45.436 ***
bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq id='71687eac06634b04cd8833ee703e61ce' type='result'>
	<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
		<jid>bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1</jid>
	</bind>
</iq>



*** User 2022-05-25 09:09:45.436 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='0c496c9f2147ad7f4f14a16c3fc0fa41'>
	<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>



*** User 2022-05-25 09:09:45.436 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq type='result' id='0c496c9f2147ad7f4f14a16c3fc0fa41'>
	<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>



*** User 2022-05-25 09:09:45.436 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<presence/>



*** User 2022-05-25 09:09:45.439 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en'/>



*** User 2022-05-25 09:09:45.439 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<stream:stream to='domain.example.com' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>

*** User 2022-05-25 09:09:45.440 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='9d7af66fda43517e' from='domain.example.com' version='1.0' xml:lang='en'>

*** User 2022-05-25 09:09:45.440 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/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>SCRAM-SHA-256</mechanism>
		<mechanism>PLAIN</mechanism>
	</mechanisms>
	<register xmlns='http://jabber.org/features/iq-register'/>
	<amp xmlns='http://jabber.org/feature/amp'/>
	<sm xmlns='urn:xmpp:sm:3'/>
</stream:features>



*** User 2022-05-25 09:09:45.440 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<auth xmlns='urn:ietf:params:xml:ns:xmpp-sasl' mechanism='PLAIN'>AGthdGVfbWVzc2FnZXNfZmlsdGVyZWRfd2hlbl9wcmVmc19kZWZhdWx0X3BvbGljeV9pc19yb3N0ZXJfMTcyNgBtYWtyb3dlO3A=</auth>



*** User 2022-05-25 09:09:45.462 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<success xmlns='urn:ietf:params:xml:ns:xmpp-sasl'/>



*** User 2022-05-25 09:09:45.462 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<stream:stream to='domain.example.com' version='1.0' xml:lang='en' xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams'>

*** User 2022-05-25 09:09:45.463 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<stream:stream xmlns='jabber:client' xmlns:stream='http://etherx.jabber.org/streams' id='d255133df0c32b3d' from='domain.example.com' version='1.0' xml:lang='en'>

*** User 2022-05-25 09:09:45.463 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/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-05-25 09:09:45.463 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='c0c9558dc198341cde8143435fdd52f7'>
	<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
		<resource>res1</resource>
	</bind>
</iq>



*** User 2022-05-25 09:09:45.463 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq id='c0c9558dc198341cde8143435fdd52f7' type='result'>
	<bind xmlns='urn:ietf:params:xml:ns:xmpp-bind'>
		<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1</jid>
	</bind>
</iq>



*** User 2022-05-25 09:09:45.464 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='931f9ee0758441b15ab9c3ba42d71b9a'>
	<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>



*** User 2022-05-25 09:09:45.464 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq type='result' id='931f9ee0758441b15ab9c3ba42d71b9a'>
	<session xmlns='urn:ietf:params:xml:ns:xmpp-session'/>
</iq>



*** User 2022-05-25 09:09:45.464 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<presence/>



*** User 2022-05-25 09:09:45.467 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en'/>



*** User 2022-05-25 09:09:45.467 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<presence type='subscribe' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>



*** User 2022-05-25 09:09:45.475 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='pushf46fdd95fde4b1ce' type='set'>
	<query xmlns='jabber:iq:roster'>
		<item ask='subscribe' subscription='none' jid='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>
	</query>
</iq>



*** User 2022-05-25 09:09:45.475 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='subscribe'/>



*** User 2022-05-25 09:09:45.475 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<presence type='subscribed' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>



*** User 2022-05-25 09:09:45.481 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='push941b3610ef8c3410' type='set'>
	<query xmlns='jabber:iq:roster'>
		<item subscription='to' jid='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>
	</query>
</iq>



*** User 2022-05-25 09:09:45.482 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='subscribed'/>



*** User 2022-05-25 09:09:45.482 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en'/>



*** User 2022-05-25 09:09:45.482 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='push527a3ed8dd0f7d83' type='set'>
	<query xmlns='jabber:iq:roster'>
		<item subscription='from' jid='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>
	</query>
</iq>



*** User 2022-05-25 09:09:45.482 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<presence type='subscribe' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>



*** User 2022-05-25 09:09:45.491 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='push372a4d94cb2e12eb' type='set'>
	<query xmlns='jabber:iq:roster'>
		<item subscription='to' jid='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>
	</query>
</iq>



*** User 2022-05-25 09:09:45.491 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='subscribe'/>



*** User 2022-05-25 09:09:45.491 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='push46462454555efa07' type='set'>
	<query xmlns='jabber:iq:roster'>
		<item ask='subscribe' subscription='from' jid='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>
	</query>
</iq>



*** User 2022-05-25 09:09:45.491 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<presence type='subscribed' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>



*** User 2022-05-25 09:09:45.500 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='push478a0c075a4a1cab' type='set'>
	<query xmlns='jabber:iq:roster'>
		<item subscription='both' jid='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>
	</query>
</iq>



*** User 2022-05-25 09:09:45.500 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='pushc984dd20cc987aa9' type='set'>
	<query xmlns='jabber:iq:roster'>
		<item subscription='both' jid='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com'/>
	</query>
</iq>



*** User 2022-05-25 09:09:45.500 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='subscribed'/>



*** User 2022-05-25 09:09:45.500 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<presence from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en'/>



*** User 2022-05-25 09:09:45.500 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='f77834c6895ae89ddc1d81bf33ba5343'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.505 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='f77834c6895ae89ddc1d81bf33ba5343' type='result'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.506 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=1, prefs={roster,[],[]}, now={1653,469785,505956}</body>
</message>



*** User 2022-05-25 09:09:45.506 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=2, prefs={roster,[],[]}, now={1653,469785,505972}</body>
</message>



*** User 2022-05-25 09:09:45.506 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=3, prefs={roster,[],[]}, now={1653,469785,505979}</body>
</message>



*** User 2022-05-25 09:09:45.506 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=4, prefs={roster,[],[]}, now={1653,469785,505987}</body>
</message>



*** User 2022-05-25 09:09:45.571 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=2, prefs={roster,[],[]}, now={1653,469785,505972}</body>
	<stanza-id by='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSR44K81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.571 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=4, prefs={roster,[],[]}, now={1653,469785,505987}</body>
	<stanza-id by='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRIHQ01' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.571 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=3, prefs={roster,[],[]}, now={1653,469785,505979}</body>
</message>



*** User 2022-05-25 09:09:45.571 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=1, prefs={roster,[],[]}, now={1653,469785,505956}</body>
	<stanza-id by='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRIHQ81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.571 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='1feab8ed0629894087d673c8152c6769'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always>
			<jid>bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</always>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.573 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='1feab8ed0629894087d673c8152c6769' type='result'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always>
			<jid>bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</always>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.573 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=1, prefs={roster,[bob],[]}, now={1653,469785,573154}</body>
</message>



*** User 2022-05-25 09:09:45.573 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=2, prefs={roster,[bob],[]}, now={1653,469785,573169}</body>
</message>



*** User 2022-05-25 09:09:45.573 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=3, prefs={roster,[bob],[]}, now={1653,469785,573176}</body>
</message>



*** User 2022-05-25 09:09:45.573 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=4, prefs={roster,[bob],[]}, now={1653,469785,573183}</body>
</message>



*** User 2022-05-25 09:09:45.576 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=2, prefs={roster,[bob],[]}, now={1653,469785,573169}</body>
	<stanza-id by='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRKKL01' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.580 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=4, prefs={roster,[bob],[]}, now={1653,469785,573183}</body>
	<stanza-id by='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRLEL01' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.581 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=1, prefs={roster,[bob],[]}, now={1653,469785,573154}</body>
	<stanza-id by='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRKKKO1' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.581 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=3, prefs={roster,[bob],[]}, now={1653,469785,573176}</body>
</message>



*** User 2022-05-25 09:09:45.581 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='95ee25dc0a8def5c3831ba8b22ae0e45'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</always>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.582 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='95ee25dc0a8def5c3831ba8b22ae0e45' type='result'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</always>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.582 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=1, prefs={roster,[kate],[]}, now={1653,469785,582462}</body>
</message>



*** User 2022-05-25 09:09:45.582 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=2, prefs={roster,[kate],[]}, now={1653,469785,582491}</body>
</message>



*** User 2022-05-25 09:09:45.582 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=3, prefs={roster,[kate],[]}, now={1653,469785,582498}</body>
</message>



*** User 2022-05-25 09:09:45.582 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=4, prefs={roster,[kate],[]}, now={1653,469785,582504}</body>
</message>



*** User 2022-05-25 09:09:45.590 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=2, prefs={roster,[kate],[]}, now={1653,469785,582491}</body>
	<stanza-id by='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRNTAG1' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.592 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=4, prefs={roster,[kate],[]}, now={1653,469785,582504}</body>
	<stanza-id by='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRONF81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.592 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=3, prefs={roster,[kate],[]}, now={1653,469785,582498}</body>
	<stanza-id by='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRNBP01' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.592 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=1, prefs={roster,[kate],[]}, now={1653,469785,582462}</body>
	<stanza-id by='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRNTA81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.592 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='5360d81b516a1a3db1af3a9b61e9e4f5'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
			<jid>bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</always>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.593 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='5360d81b516a1a3db1af3a9b61e9e4f5' type='result'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
			<jid>bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</always>
		<never/>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.594 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=1, prefs={roster,[kate,bob],[]}, now={1653,469785,593940}</body>
</message>



*** User 2022-05-25 09:09:45.594 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=2, prefs={roster,[kate,bob],[]}, now={1653,469785,593951}</body>
</message>



*** User 2022-05-25 09:09:45.594 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=3, prefs={roster,[kate,bob],[]}, now={1653,469785,593956}</body>
</message>



*** User 2022-05-25 09:09:45.594 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=4, prefs={roster,[kate,bob],[]}, now={1653,469785,593960}</body>
</message>



*** User 2022-05-25 09:09:45.598 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=2, prefs={roster,[kate,bob],[]}, now={1653,469785,593951}</body>
	<stanza-id by='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRQ2T81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.600 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=4, prefs={roster,[kate,bob],[]}, now={1653,469785,593960}</body>
	<stanza-id by='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRQEPG1' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.600 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=1, prefs={roster,[kate,bob],[]}, now={1653,469785,593940}</body>
	<stanza-id by='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRPLEO1' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.600 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=3, prefs={roster,[kate,bob],[]}, now={1653,469785,593956}</body>
	<stanza-id by='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRPVIO1' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.600 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='0df781ec4c4981c401884416aa2e32be'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never>
			<jid>bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</never>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.601 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='0df781ec4c4981c401884416aa2e32be' type='result'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never>
			<jid>bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</never>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.601 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=1, prefs={roster,[],[bob]}, now={1653,469785,601839}</body>
</message>



*** User 2022-05-25 09:09:45.602 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=2, prefs={roster,[],[bob]}, now={1653,469785,601874}</body>
</message>



*** User 2022-05-25 09:09:45.602 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=3, prefs={roster,[],[bob]}, now={1653,469785,601882}</body>
</message>



*** User 2022-05-25 09:09:45.602 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=4, prefs={roster,[],[bob]}, now={1653,469785,601888}</body>
</message>



*** User 2022-05-25 09:09:45.604 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=2, prefs={roster,[],[bob]}, now={1653,469785,601874}</body>
	<stanza-id by='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRRHH81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.611 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=4, prefs={roster,[],[bob]}, now={1653,469785,601888}</body>
	<stanza-id by='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSRS9C81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.611 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=1, prefs={roster,[],[bob]}, now={1653,469785,601839}</body>
</message>



*** User 2022-05-25 09:09:45.611 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=3, prefs={roster,[],[bob]}, now={1653,469785,601882}</body>
</message>



*** User 2022-05-25 09:09:45.611 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='156a8a4faf9aba36174688cf687fece4'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</never>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.662 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='156a8a4faf9aba36174688cf687fece4' type='result'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</never>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.662 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=1, prefs={roster,[],[kate]}, now={1653,469785,662725}</body>
</message>



*** User 2022-05-25 09:09:45.662 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=2, prefs={roster,[],[kate]}, now={1653,469785,662737}</body>
</message>



*** User 2022-05-25 09:09:45.662 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=3, prefs={roster,[],[kate]}, now={1653,469785,662742}</body>
</message>



*** User 2022-05-25 09:09:45.663 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=4, prefs={roster,[],[kate]}, now={1653,469785,662746}</body>
</message>



*** User 2022-05-25 09:09:45.671 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=2, prefs={roster,[],[kate]}, now={1653,469785,662737}</body>
	<stanza-id by='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSSBCV01' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.672 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=4, prefs={roster,[],[kate]}, now={1653,469785,662746}</body>
	<stanza-id by='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSSC88O1' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.672 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=3, prefs={roster,[],[kate]}, now={1653,469785,662742}</body>
</message>



*** User 2022-05-25 09:09:45.672 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=1, prefs={roster,[],[kate]}, now={1653,469785,662725}</body>
	<stanza-id by='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSSB6L81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.672 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='3e3eb2ef741cc280f0383f76a3a62bb5'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never>
			<jid>bOb_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</never>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.673 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='3e3eb2ef741cc280f0383f76a3a62bb5' type='result'>
	<prefs xmlns='urn:xmpp:mam:1' default='roster'>
		<always/>
		<never>
			<jid>bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
			<jid>kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com</jid>
		</never>
	</prefs>
</iq>



*** User 2022-05-25 09:09:45.673 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=1, prefs={roster,[],[bob,kate]}, now={1653,469785,673893}</body>
</message>



*** User 2022-05-25 09:09:45.674 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=2, prefs={roster,[],[bob,kate]}, now={1653,469785,673900}</body>
</message>



*** User 2022-05-25 09:09:45.674 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=3, prefs={roster,[],[bob,kate]}, now={1653,469785,673924}</body>
</message>



*** User 2022-05-25 09:09:45.674 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<message to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
	<body>n=4, prefs={roster,[],[bob,kate]}, now={1653,469785,673928}</body>
</message>



*** User 2022-05-25 09:09:45.688 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=2, prefs={roster,[],[bob,kate]}, now={1653,469785,673900}</body>
	<stanza-id by='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSSD49O1' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.694 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=4, prefs={roster,[],[bob,kate]}, now={1653,469785,673928}</body>
	<stanza-id by='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' id='BNUIDSSGDN81' xmlns='urn:xmpp:sid:0'/>
</message>



*** User 2022-05-25 09:09:45.694 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=3, prefs={roster,[],[bob,kate]}, now={1653,469785,673924}</body>
</message>


Could not find element wait_for_parallel_writer in Config.


*** User 2022-05-25 09:09:45.694 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xml:lang='en' type='chat'>
	<body>n=1, prefs={roster,[],[bob,kate]}, now={1653,469785,673893}</body>
</message>


Could not find element archive_wait in Config.


*** User 2022-05-25 09:09:45.694 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='4b880f98b42b31ff501b107ce80ac1bc'>
	<query xmlns='urn:xmpp:mam:1' queryid='page_rsm'>
		<x xmlns='jabber:x:data'/>
		<set>
			<max>50</max>
			<after/>
		</set>
	</query>
</iq>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='c3513328-6d53-4d37-877a-666746eb1853'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSR43Q01'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.506280Z' from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=2, prefs={roster,[],[]}, now={1653,469785,505972}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='a7029381-03a3-4d30-9252-aa737395eb6e'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRIHQ81'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.565417Z' from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=1, prefs={roster,[],[]}, now={1653,469785,505956}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='17a5f70c-038b-4f56-a239-978f33eb754f'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRKGMO1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.573467Z' from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=2, prefs={roster,[bob],[]}, now={1653,469785,573169}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='aaebb70c-2dcd-48d7-9f60-533d4130bcaf'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRKKKO1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.573971Z' from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=1, prefs={roster,[bob],[]}, now={1653,469785,573154}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='cb6607f6-bc43-4ec7-957a-8d7ab14fcce1'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRNBP01'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.585124Z' from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=3, prefs={roster,[kate],[]}, now={1653,469785,582498}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='3b44a94e-d77c-4b17-947d-6c5c143fecf1'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRNBPG1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.585126Z' from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=2, prefs={roster,[kate],[]}, now={1653,469785,582491}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='ca17c199-12ab-4529-b196-b3d5d3f0748b'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRNTA81'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.587369Z' from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=1, prefs={roster,[kate],[]}, now={1653,469785,582462}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='5df05074-92f6-4251-a038-2ecd26f05490'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSROF6O1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.589659Z' from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=4, prefs={roster,[kate],[]}, now={1653,469785,582504}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.698 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='e33284ce-7a36-464b-a4d3-ab3b30d92b26'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRPL9G1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.594534Z' from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=2, prefs={roster,[kate,bob],[]}, now={1653,469785,593951}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.699 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='4c3f9bc9-b503-4d48-957b-650ca6b9834b'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRPLEO1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.594555Z' from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=1, prefs={roster,[kate,bob],[]}, now={1653,469785,593940}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.699 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='508256e8-ea82-4866-b4a3-1217fac80825'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRPVIO1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.595851Z' from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=3, prefs={roster,[kate,bob],[]}, now={1653,469785,593956}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.699 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='b7cc7a83-7399-417e-bbe3-89841c032bf7'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSRQEOO1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.597795Z' from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=4, prefs={roster,[kate,bob],[]}, now={1653,469785,593960}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.699 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='c0c5b16c-4161-4101-9dff-3debeaa1aff7'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSSANBG1'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.664430Z' from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=2, prefs={roster,[],[kate]}, now={1653,469785,662737}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.699 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<message from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='e6d9a74f-1b4f-49ea-92e5-d7e3254cc326'>
	<result queryid='page_rsm' xmlns='urn:xmpp:mam:1' id='BNUIDSSB6L81'>
		<forwarded xmlns='urn:xmpp:forward:0'>
			<delay xmlns='urn:xmpp:delay' stamp='2022-05-25T09:09:45.666389Z' from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1'/>
			<message from='bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' xmlns='jabber:client' xml:lang='en' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' type='chat'>
				<body>n=1, prefs={roster,[],[kate]}, now={1653,469785,662725}</body>
			</message>
		</forwarded>
	</result>
</message>



*** User 2022-05-25 09:09:45.699 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='4b880f98b42b31ff501b107ce80ac1bc' type='result'>
	<fin xmlns='urn:xmpp:mam:1' complete='true'>
		<set xmlns='http://jabber.org/protocol/rsm'>
			<first index='0'>BNUIDSR43Q01</first>
			<last>BNUIDSSB6L81</last>
			<count>14</count>
		</set>
	</fin>
</iq>



*** User 2022-05-25 09:09:45.699 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
<iq type='set' id='1b8c24d5733afa9a5ae7dcf101bd2f20'>
	<query xmlns='urn:xmpp:mam:1' queryid='page_rsm'>
		<x xmlns='jabber:x:data'/>
		<set>
			<max>50</max>
			<after>BNUIDSSB6L81</after>
		</set>
	</query>
</iq>



*** User 2022-05-25 09:09:45.702 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
<iq from='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com' to='alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1' id='1b8c24d5733afa9a5ae7dcf101bd2f20' type='result'>
	<fin xmlns='urn:xmpp:mam:1' complete='true'>
		<set xmlns='http://jabber.org/protocol/rsm'>
			<count>14</count>
		</set>
	</fin>
</iq>



*** User 2022-05-25 09:09:45.702 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
</stream:stream>

*** User 2022-05-25 09:09:45.702 ***
kate_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
</stream:stream>

*** User 2022-05-25 09:09:45.703 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
</stream:stream>

*** User 2022-05-25 09:09:45.703 ***
bob_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
</stream:stream>

*** User 2022-05-25 09:09:45.703 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 out
</stream:stream>

*** User 2022-05-25 09:09:45.703 ***
alice_messages_filtered_when_prefs_default_policy_is_roster_1726@domain.example.com/res1 in
</stream:stream>
*** CT 2022-05-25 09:09:45.706 *** View log from node ejabberd2@localhost when finished ejabberd2@localhost_424.html
*** CT 2022-05-25 09:09:45.707 *** View log from node mongooseim@localhost when finished mongooseim@localhost_1838.html



=== Ended at 2022-05-25 09:09:45
=== successfully completed test case
=== === Returned value: ok