search

AgoraIO-Extensions / Agora-Flutter-SDK

Flutter plugin of Agora RTC SDK for Android/iOS/macOS/Windows
https://pub.dev/packages/agora_rtc_engine
MIT License
744 stars 386 forks source link

playEffect not working #300

Closed rmj-s closed 2 years ago

rmj-s commented 3 years ago

playEffect is not working for me with the network file, I'm passing the URL of the .mp3 file. It doesn't play audio and also doesn't gives any kind of error in the terminal. Flutter Version: 2.2.0-11.0.pre.136 RTC Engine Version: 3.1.2 OS: Android 10 Phone: Asus ROG Phone II

It works if the phone is not in DND mode.

LichKing-2234 commented 3 years ago

pls provide the SDK log, you can refer to setLogFile method

rmj-s commented 3 years ago 
Local Date: Fri Apr 16 22:03:06 2021
Build info: Dec 12 2020 10:51:02 r

INFO    (22: 3: 6:613 |    0)  15901; Agora SDK ver 3.2.1 build 28508, built on Dec 12 2020 10:51:50
INFO    (22: 3: 6:613 |    0)  15901; Agora SDK git ver:937e76a668 and branch:release/3.2
INFO    (22: 3: 6:613 |    0)  15901; initialize plugin manager
INFO    (22: 3: 6:613 |    0)  15901; built-in encryption is enabled
INFO    (22: 3: 6:617 |    4)  15901; built-in ssl is enabled
INFO    (22: 3: 6:617 |    0)  15901; use AHPL engine
INFO    (22: 3: 6:618 |    1)  15901; CacheManager: save cache to storage elapsed 1
INFO    (22: 3: 6:619 |    1)  15314; [API][rtc_engine_impl.cpp:1129][startService]initialize log service init finish
INFO    (22: 3: 6:619 |    0)  15314; Agora Rtc Engine SDK ver 3.2.1 build 28508, built on Dec 12 2020 10:51:54
WARN    (22: 3: 6:620 |    1)  15901; set_priorities not supported!!
INFO    (22: 3: 6:623 |    3)  15901; [nt/dt] queryDns is www.baidu.com
INFO    (22: 3: 6:623 |    0)  15901; [NetworkTester] domain is www.baidu.com
INFO    (22: 3: 6:624 |    1)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:624 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:637 |   13)  15314; [CommonUtility] [enableOrientationListener] done!
INFO    (22: 3: 6:638 |    1)  15314; [CommonUtility] [regiseterBroadcaster] done!
INFO    (22: 3: 6:638 |    0)  15314; [CommonUtility] [init] done!
INFO    (22: 3: 6:638 |    0)  15314; [AudioRoute] initialize +
INFO    (22: 3: 6:639 |    1)  15314; [AudioRoute] Monitor stopped
INFO    (22: 3: 6:640 |    1)  15314; [AudioRoute] Monitor stop state, reset
INFO    (22: 3: 6:641 |    1)  15314; [AudioRoute] Monitor stopped
INFO    (22: 3: 6:641 |    0)  15314; [AudioRoute] Headset setup: Plugged = false
INFO    (22: 3: 6:645 |    4)  15314; [AudioRoute] BT headset setup: BTHeadsetPlugged = false null
INFO    (22: 3: 6:646 |    1)  15314; [AudioRoute] initial Bluetooth SCO device unconnected
INFO    (22: 3: 6:646 |    0)  15314; [AudioRoute] initialize -
INFO    (22: 3: 6:647 |    1)  15314; [CommonUtility] manufacturer = asus
INFO    (22: 3: 6:647 |    0)  15314; [CommonUtility] hardware = qcom, suspectCount = 0
INFO    (22: 3: 6:647 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:647 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:647 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:647 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:648 |    1)  15314; doSetClientRole 1 level 2
INFO    (22: 3: 6:648 |    0)  15314; [API][rtc_engine_impl.cpp:2922][queryInterface]
INFO    (22: 3: 6:648 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:648 |    0)  15314; [API][rtc_engine_impl.cpp:4867][registerChannelEventHandler]
INFO    (22: 3: 6:649 |    1)  15314; [API][rtc_engine_impl.cpp:2439][setAppType]
INFO    (22: 3: 6:649 |    0)  15314; API call to setAppType
INFO    (22: 3: 6:660 |   11)  15901; network: 'NETWORK_UNKOWN' -> 'WIFI' ipv4/v6 '192.******.102'/'' gw '192.******.7'/'' subtype 100 level 4 ssid '****' bssid '' rssi -56 asu 0
INFO    (22: 3: 6:661 |    1)  15901; [nt/dt] queryDns is www.baidu.com
INFO    (22: 3: 6:661 |    0)  15901; [NetworkTester] domain is www.baidu.com
INFO    (22: 3: 6:661 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:661 |    0)  15901; [voet] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:661 |    0)  15901; [NetworkTester] domain is ap3.agora.io
INFO    (22: 3: 6:662 |    1)  15314; [API][rtc_engine_impl.cpp:3491][setClientRole]
INFO    (22: 3: 6:662 |    0)  15314; API call to setClientRole 1
INFO    (22: 3: 6:662 |    0)  15314; [API][rtc_engine_impl.cpp:3500][setClientRole]
WARN    (22: 3: 6:662 |    0)  15314; Current channel profile is communication, the role setting will not be applied!
INFO    (22: 3: 6:662 |    0)  15314; [API][rtc_engine_impl.cpp:3370][setChannelProfile]
INFO    (22: 3: 6:662 |    0)  15314; [API][rtc_engine_impl.cpp:991][getParameters]
INFO    (22: 3: 6:663 |    1)  15901; updateScenarioConfig: scenario(0):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(1):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 1 1 1 0 0   1
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(2):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 0 1 1 1 0   0
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(3):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 0 0 0 0 0   0
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(4):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(5):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 1 1 1 0 0   1
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(6):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(7):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 1 1 1 1 1   1
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(8):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: scenario(9):
INFO    (22: 3: 6:663 |    0)  15901; updateScenarioConfig: 0 0 0 0 0   0
ERROR   (22: 3: 6:663 |    0)  15901; audioProfile lambda: value nullptr on connect and apply default scenario
INFO    (22: 3: 6:663 |    0)  15901; [rtls] set playout delay:500 ms
INFO    (22: 3: 6:663 |    0)  15901; [voet] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:663 |    0)  15901; [NetworkTester] domain is ap3.agora.io
INFO    (22: 3: 6:663 |    0)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:663 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:664 |    1)  15901; [voet] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:664 |    0)  15901; [NetworkTester] domain is ap3.agora.io
INFO    (22: 3: 6:664 |    0)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:664 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:664 |    0)  15901; [voet] queryDns domain is ap4.agora.io
INFO    (22: 3: 6:665 |    1)  15901; [NetworkTester] domain is ap4.agora.io
INFO    (22: 3: 6:665 |    0)  15901; [voet] queryDns domain is ap4.agora.io
INFO    (22: 3: 6:665 |    0)  15901; [NetworkTester] domain is ap4.agora.io
INFO    (22: 3: 6:665 |    0)  15901; [voet] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:665 |    0)  15901; [NetworkTester] domain is ap3.agora.io
INFO    (22: 3: 6:665 |    0)  15901; [voet] queryDns domain is ap2.agora.io
INFO    (22: 3: 6:665 |    0)  15901; [NetworkTester] domain is ap2.agora.io
INFO    (22: 3: 6:666 |    1)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:666 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:666 |    0)  15901; [voet] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:666 |    0)  15901; [NetworkTester] domain is ap3.agora.io
INFO    (22: 3: 6:666 |    0)  15901; [voet] queryDns domain is ap4.agora.io
INFO    (22: 3: 6:666 |    0)  15901; [NetworkTester] domain is ap4.agora.io
INFO    (22: 3: 6:667 |    1)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:667 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:667 |    0)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:667 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:667 |    0)  15901; [voet] queryDns domain is ap2.agora.io
INFO    (22: 3: 6:667 |    0)  15901; [NetworkTester] domain is ap2.agora.io
INFO    (22: 3: 6:668 |    1)  15901; [voet] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:668 |    0)  15901; [NetworkTester] domain is ap3.agora.io
INFO    (22: 3: 6:668 |    0)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:668 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:669 |    1)  15901; [voet] queryDns domain is ap2.agora.io
INFO    (22: 3: 6:669 |    0)  15901; [NetworkTester] domain is ap2.agora.io
INFO    (22: 3: 6:669 |    0)  15901; [voet] queryDns domain is ap1.agora.io
INFO    (22: 3: 6:669 |    0)  15901; [NetworkTester] domain is ap1.agora.io
INFO    (22: 3: 6:669 |    0)  15901; [voet] queryDns domain is ap5.agora.io
INFO    (22: 3: 6:669 |    0)  15901; [NetworkTester] domain is ap5.agora.io
INFO    (22: 3: 6:670 |    1)  15901; [voet] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [NetworkTester] domain is ap3.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [ap] queryDns domain is ap4.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [base_context]queryDns domain is ap4.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [cm] queryDns domain is ap4.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [base_context]queryDns domain is ap4.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [ap] queryDns domain is ap4-tls.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [base_context]queryDns domain is ap4-tls.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [cm] queryDns domain is ap4-tls.agora.io
INFO    (22: 3: 6:670 |    0)  15901; [base_context]queryDns domain is ap4-tls.agora.io
INFO    (22: 3: 6:671 |    1)  15901; [rlbs] queryDns(ap1-tls.agora.io)
INFO    (22: 3: 6:671 |    0)  15901; [base_context]queryDns domain is ap1-tls.agora.io
INFO    (22: 3: 6:671 |    0)  15901; [cm] queryDns domain is ap1-tls.agora.io
INFO    (22: 3: 6:671 |    0)  15901; [base_context]queryDns domain is ap1-tls.agora.io
INFO    (22: 3: 6:671 |    0)  15901; [rlbs] queryDns(ap3.agora.io)
INFO    (22: 3: 6:671 |    0)  15901; [base_context]queryDns domain is ap3.agora.io
INFO    (22: 3: 6:671 |    0)  15901; [cm] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:671 |    0)  15901; [base_context]queryDns domain is ap3.agora.io
INFO    (22: 3: 6:672 |    1)  15901; [rlbs] selected: 112.126.96.46:8443
INFO    (22: 3: 6:672 |    0)  15901; create session builder 0x6ffc33b080
INFO    (22: 3: 6:672 |    0)  15901; [rlbs] selected: 101.132.108.165:8443
INFO    (22: 3: 6:673 |    1)  15901; tcp_client connecting 101.132.108.165:8443
INFO    (22: 3: 6:673 |    0)  15901; [rs]queryDns domain is report-edge.agora.io
INFO    (22: 3: 6:673 |    0)  15901; [base_context]queryDns domain is report-edge.agora.io
INFO    (22: 3: 6:673 |    0)  15901; [cm] queryDns domain is report-edge.agora.io
INFO    (22: 3: 6:673 |    0)  15901; [base_context]queryDns domain is report-edge.agora.io
INFO    (22: 3: 6:673 |    0)  15901; [ap] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:673 |    0)  15901; [base_context]queryDns domain is ap3.agora.io
INFO    (22: 3: 6:673 |    0)  15901; [cm] queryDns domain is ap3.agora.io
INFO    (22: 3: 6:673 |    0)  15901; [base_context]queryDns domain is ap3.agora.io
INFO    (22: 3: 6:674 |    1)  15901; [ap] queryDns domain is ap2-tls.agora.io
INFO    (22: 3: 6:674 |    0)  15901; [base_context]queryDns domain is ap2-tls.agora.io
INFO    (22: 3: 6:674 |    0)  15901; [cm] queryDns domain is ap2-tls.agora.io
INFO    (22: 3: 6:674 |    0)  15901; [base_context]queryDns domain is ap2-tls.agora.io
INFO    (22: 3: 6:674 |    0)  15901; [MIO] mediaIO controller created
INFO    (22: 3: 6:674 |    0)  15901; found 'asus/' for device 'asus/asus_i001de/ww_i001d/asus_i001_1/29/4.14.117-perf'
INFO    (22: 3: 6:674 |    0)  15901; found 'NULL' device: 'asus/asus_i001de/ww_i001d/asus_i001_1/29/4.14.117-perf'
INFO    (22: 3: 6:675 |    1)  15901; CacheManager: save cache to storage elapsed 0
INFO    (22: 3: 6:675 |    0)  15901; [ap] selected: 112.126.96.46:8443
INFO    (22: 3: 6:675 |    0)  15901; [ap] aut - creating channel with 112.126.96.46:8443, ts 0, flag: 72
INFO    (22: 3: 6:675 |    0)  15901; create session builder 0x70804fd800
INFO    (22: 3: 6:675 |    0)  15901; [ap] selected: 50.17.126.121:8443
INFO    (22: 3: 6:675 |    0)  15901; [ap] aut - creating channel with 50.17.126.121:8443, ts 0, flag: 72
INFO    (22: 3: 6:675 |    0)  15901; create session builder 0x70804fd980
INFO    (22: 3: 6:675 |    0)  15901; [ap] selected: 52.58.56.244:8443
INFO    (22: 3: 6:675 |    0)  15901; [ap] aut - creating channel with 52.58.56.244:8443, ts 0, flag: 72
INFO    (22: 3: 6:675 |    0)  15901; create session builder 0x70804fdb00
INFO    (22: 3: 6:675 |    0)  15901; [ap] selected: 101.132.108.165:8443
INFO    (22: 3: 6:675 |    0)  15901; tcp_client connecting 101.132.108.165:8443
INFO    (22: 3: 6:675 |    0)  15901; [xdump] init enable:1, dumpfile:1
INFO    (22: 3: 6:678 |    3)  15901; [rp] init service xdump:1, file:1, upload:1
INFO    (22: 3: 6:679 |    1)  15901; [rp] {"che.android_simulator":false}
INFO    (22: 3: 6:679 |    0)  15901; [rp] {"che.android_version":29}
INFO    (22: 3: 6:679 |    0)  15901; [rp] {"data.report.event.10000":{"id":10000,"report_count":10,"report_interval":6,"type":"event"}}
INFO    (22: 3: 6:679 |    0)  15901; [rp] set config type:event, id:10000, interval:6, count:10
INFO    (22: 3: 6:679 |    0)  15901; [rp] {"data.report.event.328":{"id":328,"report_count":0,"report_interval":6,"type":"event"}}
INFO    (22: 3: 6:679 |    0)  15901; [rp] set config type:event, id:328, interval:6, count:0
INFO    (22: 3: 6:679 |    0)  15901; [rp] {"rtc.client_role":1}
INFO    (22: 3: 6:679 |    0)  15901; [rtls] set playout delay:0 ms
INFO    (22: 3: 6:679 |    0)  15901; set client role to broadcaster
INFO    (22: 3: 6:679 |    0)  15901; [rp] {"rtc.audio.enabled":true,"che.audio.enable.recording.device":true}
INFO    (22: 3: 6:679 |    0)  15901; [rp] ["rtc.force_old_channel_profile"]
INFO    (22: 3: 6:679 |    0)  15901; [rp] res: {"rtc.force_old_channel_profile":false} 
INFO    (22: 3: 6:679 |    0)  15901; create dangling client connection 0x708420d800
INFO    (22: 3: 6:684 |    5)  15901; [remote:112.126.96.46:8443] start 0th connect, send client hello 8776972|syn, tags: SNI :3131322d3132...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:684 |    0)  15901; create dangling client connection 0x708420dc00
INFO    (22: 3: 6:688 |    4)  15901; [remote:112.126.96.46:8443] start 0th connect, send client hello 4464658|syn, tags: SNI :3131322d3132...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:688 |    0)  15901; create dangling client connection 0x708433e000
INFO    (22: 3: 6:693 |    5)  15901; [remote:50.17.126.121:8443] start 0th connect, send client hello 13599346|syn, tags: SNI :35302d31372d...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:693 |    0)  15901; create dangling client connection 0x708433e400
INFO    (22: 3: 6:698 |    5)  15901; [remote:52.58.56.244:8443] start 0th connect, send client hello 6688476|syn, tags: SNI :35322d35382d...(26), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:698 |    0)  15314; API call to setChannelProfile 0
INFO    (22: 3: 6:698 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:698 |    0)  15901; [rp] {"che.video.h264.hwenc":0}
INFO    (22: 3: 6:699 |    1)  15314; doSetClientRole 1 level 2
INFO    (22: 3: 6:699 |    0)  15314; [API][rtc_engine_impl.cpp:2922][queryInterface]
INFO    (22: 3: 6:699 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:699 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:699 |    0)  15314; [API][rtc_engine_impl.cpp:2922][queryInterface]
INFO    (22: 3: 6:699 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:699 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:699 |    0)  15901; [rp] {"rtc.client_role":1}
INFO    (22: 3: 6:699 |    0)  15901; [rp] {"rtc.allow_communication_fallback":true}
INFO    (22: 3: 6:699 |    0)  15901; [rp] {"rtc.user_set_channel_profile":0}
INFO    (22: 3: 6:699 |    0)  15901; [rp] {"rtc.suspend_callback_client_role_changed":false}
INFO    (22: 3: 6:702 |    3)  15314; [API][rtc_engine_impl.cpp:1034][notifyNetworkChange]
INFO    (22: 3: 6:703 |    1)  15314; [API][rtc_engine_impl.cpp:3491][setClientRole]
INFO    (22: 3: 6:703 |    0)  15314; API call to setClientRole 1
INFO    (22: 3: 6:703 |    0)  15314; [API][rtc_engine_impl.cpp:3500][setClientRole]
WARN    (22: 3: 6:703 |    0)  15314; Current channel profile is communication, the role setting will not be applied!
INFO    (22: 3: 6:703 |    0)  15314; [AudioRoute] Headset disconnected
INFO    (22: 3: 6:703 |    0)  15314; [AudioRoute] Bluetooth SCO device disconnected
INFO    (22: 3: 6:708 |    5)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3: 6:709 |    1)  15901; [rp] {"che.video.view_orientation":{"uid":0,"orientation":0}}
INFO    (22: 3: 6:746 |   37)  15901; [dns] parsed ip 103.235.46.39
INFO    (22: 3: 6:746 |    0)  15901; [nt/dt] domain is www.baidu.com, ip is 103.235.46.39
INFO    (22: 3: 6:758 |   12)  15901; [dns] parsed ip 128.1.78.146
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 148.153.116.175
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 18.195.199.4
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 3.9.229.6
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 128.1.77.34
INFO    (22: 3: 6:758 |    0)  15901; [voet] onParsedDns is 128.1.78.146
INFO    (22: 3: 6:758 |    0)  15901; [voet] onParsedDns is 148.153.116.175
INFO    (22: 3: 6:758 |    0)  15901; [voet] onParsedDns is 18.195.199.4
INFO    (22: 3: 6:758 |    0)  15901; [voet] onParsedDns is 3.9.229.6
INFO    (22: 3: 6:758 |    0)  15901; [voet] onParsedDns is 128.1.77.34
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 128.1.78.146
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 148.153.116.175
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 18.195.199.4
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 3.9.229.6
INFO    (22: 3: 6:758 |    0)  15901; [dns] parsed ip 128.1.77.34
INFO    (22: 3: 6:758 |    0)  15901; [rlbs] onParsedDns ap3.agora.io with err 0, 128.1.78.146, 148.153.116.175, 18.195.199.4, 3.9.229.6, 128.1.77.34, 
INFO    (22: 3: 6:760 |    2)  15901; [dns] parsed ip 128.1.78.146
INFO    (22: 3: 6:760 |    0)  15901; [dns] parsed ip 148.153.116.175
INFO    (22: 3: 6:760 |    0)  15901; [dns] parsed ip 18.195.199.4
INFO    (22: 3: 6:760 |    0)  15901; [dns] parsed ip 3.9.229.6
INFO    (22: 3: 6:760 |    0)  15901; [dns] parsed ip 128.1.77.34
INFO    (22: 3: 6:760 |    0)  15901; [ap] onParsedDns ap3.agora.io with err 0, 128.1.78.146, 148.153.116.175, 18.195.199.4, 3.9.229.6, 128.1.77.34, 
INFO    (22: 3: 6:775 |   15)  15901; [dns] parsed ip 52.59.134.47
INFO    (22: 3: 6:775 |    0)  15901; [dns] parsed ip 18.134.183.28
INFO    (22: 3: 6:775 |    0)  15901; [rlbs] onParsedDns ap1-tls.agora.io with err 0, 52.59.134.47, 18.134.183.28, 
INFO    (22: 3: 6:776 |    1)  15901; [dns] parsed ip 52.59.134.47
INFO    (22: 3: 6:776 |    0)  15901; [dns] parsed ip 18.134.183.28
INFO    (22: 3: 6:776 |    0)  15901; [ap] onParsedDns ap2-tls.agora.io with err 0, 52.59.134.47, 18.134.183.28, 
INFO    (22: 3: 6:881 |  105)  15901; [remote:52.58.56.244:8443] start 1th connect, send client hello 6688476|syn, tags: SNI :35322d35382d...(26), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:894 |   13)  15901; [remote:112.126.96.46:8443] start 1th connect, send client hello 8776972|syn, tags: SNI :3131322d3132...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:918 |   24)  15901; [remote:112.126.96.46:8443] start 1th connect, send client hello 4464658|syn, tags: SNI :3131322d3132...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:926 |    8)  15901; [remote:52.58.56.244:8443] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3: 6:926 |    0)  15901; [remote:52.58.56.244:8443] receive server hello piece id: 1, 2/10, not complete
INFO    (22: 3: 6:927 |    1)  15901; [remote:52.58.56.244:8443] receive server hello piece id: 2, 3/10, not complete
INFO    (22: 3: 6:927 |    0)  15901; [remote:52.58.56.244:8443] receive server hello piece id: 3, 4/10, not complete
INFO    (22: 3: 6:927 |    0)  15901; [remote:52.58.56.244:8443] receive server hello piece id: 4, 5/10, complete
INFO    (22: 3: 6:955 |   28)  15901; [remote:52.58.56.244:8443] create connection 0x7007bbbe00, self initial seq: 6688477, initial rtt: 257ms, git tag: Unknown, perspective: Perspective::kClient, cc: BBRv1, pacing: enable
INFO    (22: 3: 6:955 |    0)  15901; [remote:52.58.56.244:8443] create session 0x701e70d600
INFO    (22: 3: 6:955 |    0)  15901; [ap/aut] connected with 52.58.56.244:8443
INFO    (22: 3: 6:955 |    0)  15901; destroy dangling client connection 0x708433e400
INFO    (22: 3: 6:956 |    1)  15901; [remote:50.17.126.121:8443] start 1th connect, send client hello 13599346|syn, tags: SNI :35302d31372d...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 6:966 |   10)  15901; [remote:50.17.126.121:8443] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3: 6:966 |    0)  15901; [remote:50.17.126.121:8443] receive server hello piece id: 1, 2/10, not complete
INFO    (22: 3: 6:966 |    0)  15901; [remote:50.17.126.121:8443] receive server hello piece id: 2, 3/10, not complete
INFO    (22: 3: 6:968 |    2)  15901; [remote:50.17.126.121:8443] receive server hello piece id: 3, 4/10, not complete
INFO    (22: 3: 6:969 |    1)  15901; [remote:50.17.126.121:8443] receive server hello piece id: 4, 5/10, complete
INFO    (22: 3: 6:980 |   11)  15901; [remote:50.17.126.121:8443] create connection 0x6ffc4c2c00, self initial seq: 13599347, initial rtt: 287ms, git tag: Unknown, perspective: Perspective::kClient, cc: BBRv1, pacing: enable
INFO    (22: 3: 6:980 |    0)  15901; [remote:50.17.126.121:8443] create session 0x701e70d900
INFO    (22: 3: 6:980 |    0)  15901; [ap/aut] connected with 50.17.126.121:8443
INFO    (22: 3: 6:980 |    0)  15901; destroy dangling client connection 0x708433e000
INFO    (22: 3: 7: 51 |    0)  15901; [remote:112.126.96.46:8443] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3: 7: 68 |   17)  15901; [remote:112.126.96.46:8443] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3: 7:174 |  106)  15901; [ap/u] **responsed from 52.58.56.244:8443, CDS(8).
INFO    (22: 3: 7:175 |    1)  15901; [ap] onAPCdsRes success with config: ¸Æ¯ßÔÚ¤—ÑúÊÏŸá’–²ÂÛÜ­ÆÉâ“Ï
INFO    (22: 3: 7:175 |    0)  15901; [cs] applied directly: {"configs":{},"version":""}, elapsed: 0
INFO    (22: 3: 7:177 |    2)  15901; CacheManager: save cache to storage elapsed 2
INFO    (22: 3: 7:178 |    1)  15901; [ap/u] **responsed from 52.58.56.244:8443, TDS(64).
INFO    (22: 3: 7:178 |    0)  15901; [ap] onAPTdsRes success with config: {}, size: 0
INFO    (22: 3: 7:179 |    1)  15901; CacheManager: save cache to storage elapsed 1
INFO    (22: 3: 7:244 |   65)  15901; [ap/u] **responsed from 50.17.126.121:8443, CDS(8).
INFO    (22: 3: 7:246 |    2)  15901; [ap/u] **responsed from 50.17.126.121:8443, TDS(64).
INFO    (22: 3: 7:275 |   29)  15901; [remote:112.126.96.46:8443] start 2th connect, send client hello 8776972|syn, tags: SNI :3131322d3132...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 7:307 |   32)  15901; [remote:112.126.96.46:8443] start 2th connect, send client hello 4464658|syn, tags: SNI :3131322d3132...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 7:546 |  239)  15901; [rlbs] request rs list from 101.132.108.165:8443 with fake ch report_lbs_1618590787546.......
INFO    (22: 3: 7:634 |   88)  15901; [remote:52.58.56.244:8443] on connection close received, reason: 0, detail: 
INFO    (22: 3: 7:635 |    1)  15901; [remote:52.58.56.244:8443] start time wait, duration: 2000 ms
ERROR   (22: 3: 7:635 |    0)  15901; [ap] aut socket error with 52.58.56.244:8443
INFO    (22: 3: 7:635 |    0)  15901; [remote:52.58.56.244:8443] destroy session 0x701e70d600
INFO    (22: 3: 7:635 |    0)  15901; [remote:52.58.56.244:8443] destroy connection 0x7007bbbe00
WARN    (22: 3: 7:671 |   36)  15901; ahpl_close failed with error=9
INFO    (22: 3: 7:675 |    4)  15901; destroy dangling client connection 0x708420dc00
INFO    (22: 3: 7:675 |    0)  15901; [remote:50.17.126.121:8443] destroy session 0x701e70d900
INFO    (22: 3: 7:675 |    0)  15901; [remote:50.17.126.121:8443] destroy connection 0x6ffc4c2c00
INFO    (22: 3: 8: 89 |    0)  15901; [rlbs] [report servers]: 129.227.205.198
INFO    (22: 3: 8: 89 |    0)  15901; [rlbs] [report servers]: 129.227.205.179
INFO    (22: 3: 8: 89 |    0)  15901; [rlbs] [report servers]: 129.227.156.4
INFO    (22: 3: 8: 89 |    0)  15901; [rlbs/t] responsed from 101.132.108.165:8443 with servers 129.227.205.198:8130
INFO    (22: 3: 8: 90 |    1)  15901; [rs] updateServers 129.227.205.198:8130, priority 3
INFO    (22: 3: 8: 90 |    0)  15901; [rs] updateServers 129.227.205.179:8130, priority 3
INFO    (22: 3: 8: 90 |    0)  15901; [rs] updateServers 129.227.156.4:8130, priority 3
INFO    (22: 3: 8: 90 |    0)  15901; create session builder 0x70804fd980
INFO    (22: 3: 8: 90 |    0)  15901; create session builder 0x701e70d900
INFO    (22: 3: 8: 91 |    1)  15901; destroy dangling client connection 0x708420d800
WARN    (22: 3: 8: 92 |    1)  15901; ahpl_close failed with error=9
INFO    (22: 3: 8: 93 |    1)  15901; create dangling client connection 0x708433e000
INFO    (22: 3: 8:129 |   36)  15901; [remote:129.227.205.198:8130] start 0th connect, send client hello 1179619|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 8:129 |    0)  15901; create dangling client connection 0x708420d800
INFO    (22: 3: 8:149 |   20)  15901; [remote:129.227.205.179:8130] start 0th connect, send client hello 14735208|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 8:308 |  159)  15901; [remote:129.227.205.179:8130] start 1th connect, send client hello 14735208|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 8:309 |    1)  15901; [remote:129.227.205.198:8130] start 1th connect, send client hello 1179619|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 8:736 |  427)  15901; [remote:129.227.205.179:8130] start 2th connect, send client hello 14735208|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 8:780 |   44)  15901; [remote:129.227.205.198:8130] start 2th connect, send client hello 1179619|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 9:486 |    0)  15901; [remote:129.227.205.179:8130] start 3th connect, send client hello 14735208|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3: 9:561 |   75)  15901; [remote:129.227.205.198:8130] start 3th connect, send client hello 1179619|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:10:446 |    0)  15314; [API][rtc_engine_impl.cpp:366][joinChannel]
INFO    (22: 3:10:446 |    0)  15314; [API][rtc_engine_impl.cpp:3274][setAudioProfile]
INFO    (22: 3:10:446 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3:10:446 |    0)  15901; [rp] {"che.audio.profile":{"config":7,"scenario":7}}
INFO    (22: 3:10:446 |    0)  15901; audioProfile lambda: Audio Profile is set to: (config = 7, scenario = 7)
INFO    (22: 3:10:447 |    1)  15901; updateScenarioConfig: scenario(0):
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: scenario(1):
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: 1 1 1 0 0   1
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: scenario(2):
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: 0 1 1 1 0   0
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: scenario(3):
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: 0 0 0 0 0   0
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: scenario(4):
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: scenario(5):
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: 1 1 1 0 0   1
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: scenario(6):
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3:10:447 |    0)  15901; updateScenarioConfig: scenario(7):
INFO    (22: 3:10:448 |    1)  15901; updateScenarioConfig: 1 1 1 1 1   1
INFO    (22: 3:10:448 |    0)  15901; updateScenarioConfig: scenario(8):
INFO    (22: 3:10:448 |    0)  15901; updateScenarioConfig: 0 0 1 0 0   0
INFO    (22: 3:10:448 |    0)  15901; updateScenarioConfig: scenario(9):
INFO    (22: 3:10:448 |    0)  15901; updateScenarioConfig: 0 0 0 0 0   0
INFO    (22: 3:10:449 |    1)  15314; doSetClientRole 1 level 2
INFO    (22: 3:10:449 |    0)  15314; [API][rtc_engine_impl.cpp:2922][queryInterface]
INFO    (22: 3:10:449 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3:10:449 |    0)  15314; API call to join channel 'user:2' uid 2, SDK ver 3.2.1 build 28508, device info 'asus/asus_i001de/ww_i001d/asus_i001_1/29/4.14.117-perf'
INFO    (22: 3:10:449 |    0)  15901; [rp] {"rtc.client_role":1}
INFO    (22: 3:10:449 |    0)  15314; [API][rtc_engine_impl.cpp:5353][initialize]
INFO    (22: 3:10:449 |    0)  15314; API call to initialize rtc channel user:2
INFO    (22: 3:10:451 |    2)  15314; [AudioRoute] default routing: Earpiece bluetooth false, current routing: Default, actual system routing: Speakerphone
INFO    (22: 3:10:452 |    1)  15314; [AudioRoute] reset audio routing, default routing: Earpiece, current routing: Default, target routing: Earpiece, actual system routing: Speakerphone
INFO    (22: 3:10:453 |    1)  15314; [AudioRoute] set audio output routing from Default to Earpiece
INFO    (22: 3:10:459 |    6)  15314; [API][rtc_engine_impl.cpp:2922][queryInterface]
INFO    (22: 3:10:459 |    0)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3:10:459 |    0)  15901; [rp] {"che.audio.output.routing":1}
INFO    (22: 3:10:460 |    1)  15314; [AudioRoute] audio routing changed to Earpiece
INFO    (22: 3:10:460 |    0)  15314; [AudioRoute] Monitor start: default routing: Earpiece, current routing: Earpiece
INFO    (22: 3:10:464 |    4)  15314; [AudioRoute] default routing: Earpiece bluetooth false, current routing: Earpiece, actual system routing: Earpiece
INFO    (22: 3:10:469 |    5)  15314; [AudioRoute] reset audio routing, default routing: Earpiece, current routing: Earpiece, target routing: Earpiece, actual system routing: Earpiece
INFO    (22: 3:10:470 |    1)  15314; [AudioRoute] Monitor reset: default routing: Earpiece, current routing: Earpiece
INFO    (22: 3:10:476 |    6)  15314; [API][rtc_engine_impl.cpp:1034][notifyNetworkChange]
INFO    (22: 3:10:476 |    0)  15901; doStopLastmileProbeTest
INFO    (22: 3:10:476 |    0)  15901; ***CALL BEGIN: appid:'bc****************************4a' cname:'user:2' info:'' sid:'9FAE823101B0468E94F6CBD6E88E932E'
INFO    (22: 3:10:476 |    0)  15901; addRef of media engine, ref=1
INFO    (22: 3:10:477 |    1)  15901; [che] create chat engine, ctx:0x6fe40766c0
WARN    (22: 3:10:477 |    0)  15901; VoiceEngine::SetAndroidObjects engine context 0
INFO    (22: 3:10:477 |    0)  15901; opensl 0 android ver 29 banned level 22 scenario 7 androidHighQualitySLEnable 0
WARN    (22: 3:10:477 |    0)  15901; VoiceEngine::SetAndroidObjects engine context 165
INFO    (22: 3:10:477 |    0)  15901; use android JNI device recording
INFO    (22: 3:10:478 |    1)  15901; [MYDEBUG] large group call false
INFO    (22: 3:10:478 |    0)  15901; applyMediaEngineMode(): 264_Hardware decoding false,265_Hardware decoding false
INFO    (22: 3:10:478 |    0)  15901; setupMediaEngineMode: mode 2
WARN    (22: 3:10:478 |    0)  15901; setupMediaEngineMode: skip updateClientRole as audio engine not created, mode 2
INFO    (22: 3:10:478 |    0)  15901; Set audio rs-fec 1
INFO    (22: 3:10:478 |    0)  15901; engine git commit version:038d58fad4 and branch:release/3.2
INFO    (22: 3:10:478 |    0)  15901; [Noise Supp]: Using floating point noise suppression
INFO    (22: 3:10:478 |    0)  15901; [Noise Supp]: Using floating point noise suppression
INFO    (22: 3:10:478 |    0)  15901; set audiolayer 0
INFO    (22: 3:10:478 |    0)  15901; output: kPlatformDefaultAudio
INFO    (22: 3:10:478 |    0)  15901; CreatePlatformSpecificObjects opensl 0 android ver 29 banned level 22
INFO    (22: 3:10:479 |    1)  15314; [API][rtc_engine_impl.cpp:980][setParameters]
ERROR   (22: 3:10:479 |    0)  15901; AsyncAudioDevice constructed, counter: 1

INFO    (22: 3:10:480 |    1)  15901; audio jitterbuffer new smooth
INFO    (22: 3:10:480 |    0)  15901; [Noise Supp]: Using floating point noise suppression
INFO    (22: 3:10:480 |    0)  15901; [Noise Supp]: Using floating point noise suppression
INFO    (22: 3:10:482 |    2)  15901; OutputMixer: start audio file decoder thread successfully
INFO    (22: 3:10:482 |    0)  15901;   OS info: Android
INFO    (22: 3:10:485 |    3)  15980; [JNI] InitSampleRate Recording 16000
INFO    (22: 3:10:485 |    0)  15980; [JNI] InitSampleRate playout 48000 , res = 48000
INFO    (22: 3:10:486 |    1)  15901; Set stereo playback available = 0
INFO    (22: 3:10:486 |    0)  15901; StereoPlayoutIsAvailable(), output: available=0
INFO    (22: 3:10:486 |    0)  15901; StereoRecordingIsAvailable(), output: available=0
WARN    (22: 3:10:486 |    0)  15901; enableLocalRecordingDevice: enable 1 already set
INFO    (22: 3:10:486 |    0)  15901; setMuteStatus, muted: Off
INFO    (22: 3:10:486 |    0)  15901; setMuteOutput, muted: false
INFO    (22: 3:10:487 |    1)  15980; [JNI] playback device is set to 0
INFO    (22: 3:10:487 |    0)  15901; Audio Engine Init success, mSpecMode 2
INFO    (22: 3:10:487 |    0)  15901; [che] chat engine initialized
INFO    (22: 3:10:487 |    0)  15901; [time] process EngineInitialize takes 10
INFO    (22: 3:10:488 |    1)  15980; [AudioDevice Java] enableHardwareEarback false
INFO    (22: 3:10:488 |    0)  15901; [tactics] version:3.2.1 maxBitrate:400 640X360 15 fps needHandle:1
INFO    (22: 3:10:488 |    0)  15980; [AudioDevice Java] enableHardwareEarback false ret -7
INFO    (22: 3:10:488 |    0)  15901; [tactics] config json version:20150101-0000 duallinkd:true poor:0
INFO    (22: 3:10:489 |    1)  15901; [tactics] parse config for beckon error for tactics size:15
INFO    (22: 3:10:489 |    0)  15901; [vocs] queryDns ap2-tls.agora.io
INFO    (22: 3:10:489 |    0)  15901; [base_context]queryDns domain is ap2-tls.agora.io
INFO    (22: 3:10:489 |    0)  15901; [vocs] onParsedDns ap2-tls.agora.io with err 0, 52.59.134.47, 18.134.183.28, 
INFO    (22: 3:10:489 |    0)  15901; [vocs] queryDns ap3.agora.io
INFO    (22: 3:10:489 |    0)  15901; [base_context]queryDns domain is ap3.agora.io
INFO    (22: 3:10:489 |    0)  15901; [vocs] onParsedDns ap3.agora.io with err 0, 128.1.78.146, 148.153.116.175, 18.195.199.4, 3.9.229.6, 128.1.77.34, 
INFO    (22: 3:10:489 |    0)  15901; [vocs] vocs initialized
INFO    (22: 3:10:489 |    0)  15901; [cc] fecRexferEnabled:0
INFO    (22: 3:10:489 |    0)  15901; [cm] reset channelProfile to NASA(CHANNEL_PROFILE_LIVE_BROADCASTING)
INFO    (22: 3:10:489 |    0)  15901; add ping address 192.168.7.7
INFO    (22: 3:10:490 |    1)  15901; PING 192.168.7.7:0 16(44) bytes of data
INFO    (22: 3:10:490 |    0)  15901; CacheManager: save cache to storage elapsed 0
INFO    (22: 3:10:490 |    0)  15901; [cm] emit join channel signal, size=4
INFO    (22: 3:10:490 |    0)  15901; [cm] connection state changed from 1 to 2
INFO    (22: 3:10:490 |    0)  15901; [tactics] version:3.2.1 maxBitrate:400 640X360 15 fps needHandle:1
INFO    (22: 3:10:490 |    0)  15901; [vocs] lookup channel...
INFO    (22: 3:10:490 |    0)  15901; [vocs] selected: 128.1.78.146:8443
INFO    (22: 3:10:490 |    0)  15901; [vocs] report bitrate: a/v/t: 50/400/450
INFO    (22: 3:10:490 |    0)  15901; [vocs] aut - creating channel with 128.1.78.146:8443, ts 1618590790490.......
INFO    (22: 3:10:490 |    0)  15901; create session builder 0x701e70e080
INFO    (22: 3:10:490 |    0)  15901; [vocs] selected: 148.153.116.175:8443
INFO    (22: 3:10:490 |    0)  15901; [vocs] report bitrate: a/v/t: 50/400/450
INFO    (22: 3:10:490 |    0)  15901; [vocs] aut - creating channel with 148.153.116.175:8443, ts 1618590790490.......
INFO    (22: 3:10:490 |    0)  15901; create session builder 0x6ffc33ac00
INFO    (22: 3:10:490 |    0)  15901; [vocs] selected: 18.195.199.4:8443
INFO    (22: 3:10:490 |    0)  15901; [vocs] report bitrate: a/v/t: 50/400/450
INFO    (22: 3:10:490 |    0)  15901; [vocs] aut - creating channel with 18.195.199.4:8443, ts 1618590790490.......
INFO    (22: 3:10:490 |    0)  15901; create session builder 0x6ffc33b080
INFO    (22: 3:10:490 |    0)  15901; [vocs] selected: 52.59.134.47:8443
INFO    (22: 3:10:492 |    2)  15901; tcp_client connecting 52.59.134.47:8443
INFO    (22: 3:10:492 |    0)  15901; [rp] {"che.audio.game_play_effect":{"soundId":1,"filePath":"https://our-website.com/sounds/call_warning.mp3","loopCount":0,"pitch":1,"pan":1,"gain":99,"send2far":1}}
INFO    (22: 3:10:492 |    0)  15901; [Effect], Android using hardware audio file decoder
INFO    (22: 3:10:493 |    1)  15901; [MediaCodec Audio Decoder] Try to decode audio file : https://our-website.com/sounds/call_warning.mp3
ERROR   (22: 3:11:343 |    0)  15901; [MediaCodec Audio Decoder] Connect timeout on URL : https://our-website.com/sounds/call_warning.mp3
INFO    (22: 3:11:344 |    1)  15901; [MediaCodec Audio Decoder] Try to decode audio file : https://our-website.com/sounds/call_warning.mp3
ERROR   (22: 3:12:191 |    0)  15901; [MediaCodec Audio Decoder] Connect timeout on URL : https://our-website.com/sounds/call_warning.mp3
ERROR   (22: 3:12:192 |    1)  15901; PlayEffect() failed to start the effect mixing (error=10035)
INFO    (22: 3:12:192 |    0)  15901; create dangling client connection 0x7084236c00
INFO    (22: 3:12:211 |   19)  15901; [remote:128.1.78.146:8443] start 0th connect, send client hello 3662188|syn, tags: SNI :3132382d312d...(26), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:211 |    0)  15901; create dangling client connection 0x708433ec00
INFO    (22: 3:12:226 |   15)  15901; [remote:148.153.116.175:8443] start 0th connect, send client hello 2090309|syn, tags: SNI :3134382d3135...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:226 |    0)  15901; create dangling client connection 0x7007aa3c00
INFO    (22: 3:12:236 |   10)  15901; [remote:18.195.199.4:8443] start 0th connect, send client hello 11435726|syn, tags: SNI :31382d313935...(26), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:237 |    1)  15901; [remote:129.227.205.179:8130] start 4th connect, send client hello 14735208|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:237 |    0)  15901; [remote:129.227.205.198:8130] start 4th connect, send client hello 1179619|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:237 |    0)  15901; [rs] **report stats: seq: 27, report list size 27, tx/rx: 0/0, cache size: 0
INFO    (22: 3:12:238 |    1)  15901; [dns] parsed ip 129.227.71.197
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 164.52.32.56
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 23.236.96.162
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 164.52.32.58
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 164.52.32.57
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 128.1.193.223
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 23.248.186.179
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 128.1.193.224
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 23.236.96.163
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 129.227.71.196
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 23.248.186.180
INFO    (22: 3:12:238 |    0)  15901; [dns] parsed ip 164.52.32.59
INFO    (22: 3:12:238 |    0)  15901; [rs] dns parse result code: 0, servers size: 12
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 129.227.71.197
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 164.52.32.56
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 23.236.96.162
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 164.52.32.58
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 164.52.32.57
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 128.1.193.223
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 23.248.186.179
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 128.1.193.224
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 23.236.96.163
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 129.227.71.196
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 23.248.186.180
INFO    (22: 3:12:238 |    0)  15901; [rs] onParsedDns 164.52.32.59
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 129.227.71.197:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 164.52.32.56:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 23.236.96.162:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 164.52.32.58:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 164.52.32.57:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 128.1.193.223:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 23.248.186.179:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 128.1.193.224:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 23.236.96.163:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 129.227.71.196:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 23.248.186.180:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; [rs] updateServers 164.52.32.59:8130, priority 2
INFO    (22: 3:12:238 |    0)  15901; destroy dangling client connection 0x708433e000
INFO    (22: 3:12:238 |    0)  15901; create session builder 0x70804fd980
INFO    (22: 3:12:238 |    0)  15901; destroy dangling client connection 0x708420d800
INFO    (22: 3:12:238 |    0)  15901; create session builder 0x701e70d900
INFO    (22: 3:12:239 |    1)  15901; create dangling client connection 0x708420d800
INFO    (22: 3:12:247 |    8)  15901; [remote:129.227.205.198:8130] start 0th connect, send client hello 8426920|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:247 |    0)  15901; create dangling client connection 0x708433e000
INFO    (22: 3:12:254 |    7)  15901; [remote:129.227.205.179:8130] start 0th connect, send client hello 12813586|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:380 |  126)  15901; [remote:128.1.78.146:8443] start 1th connect, send client hello 3662188|syn, tags: SNI :3132382d312d...(26), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:405 |   25)  15901; [remote:129.227.205.198:8130] start 1th connect, send client hello 8426920|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:412 |    7)  15901; [remote:128.1.78.146:8443] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3:12:413 |    1)  15901; [remote:128.1.78.146:8443] receive server hello piece id: 2, 2/10, not complete
INFO    (22: 3:12:413 |    0)  15901; [remote:128.1.78.146:8443] receive server hello piece id: 4, 3/10, not complete
INFO    (22: 3:12:413 |    0)  15901; [remote:128.1.78.146:8443] receive server hello piece id: 1, 4/10, not complete
INFO    (22: 3:12:413 |    0)  15901; [remote:128.1.78.146:8443] receive server hello piece id: 6, 5/10, complete
INFO    (22: 3:12:421 |    8)  15901; [remote:128.1.78.146:8443] create connection 0x6ffc4c2c00, self initial seq: 3662189, initial rtt: 210ms, git tag: Unknown, perspective: Perspective::kClient, cc: BBRv1, pacing: enable
INFO    (22: 3:12:421 |    0)  15901; [remote:128.1.78.146:8443] create session 0x6ffc50fa80
INFO    (22: 3:12:421 |    0)  15901; [vocs/aut] connected with 128.1.78.146:8443
INFO    (22: 3:12:421 |    0)  15901; destroy dangling client connection 0x7084236c00
INFO    (22: 3:12:445 |   24)  15901; [remote:18.195.199.4:8443] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3:12:445 |    0)  15901; [remote:18.195.199.4:8443] receive server hello piece id: 1, 2/10, not complete
INFO    (22: 3:12:445 |    0)  15901; [remote:18.195.199.4:8443] receive server hello piece id: 2, 3/10, not complete
INFO    (22: 3:12:445 |    0)  15901; [remote:18.195.199.4:8443] receive server hello piece id: 3, 4/10, not complete
INFO    (22: 3:12:445 |    0)  15901; [remote:18.195.199.4:8443] receive server hello piece id: 4, 5/10, complete
INFO    (22: 3:12:458 |   13)  15901; [remote:18.195.199.4:8443] create connection 0x7007bbbe00, self initial seq: 11435727, initial rtt: 222ms, git tag: Unknown, perspective: Perspective::kClient, cc: BBRv1, pacing: enable
INFO    (22: 3:12:458 |    0)  15901; [remote:18.195.199.4:8443] create session 0x6ffc511a00
INFO    (22: 3:12:458 |    0)  15901; [vocs/aut] connected with 18.195.199.4:8443
INFO    (22: 3:12:458 |    0)  15901; destroy dangling client connection 0x7007aa3c00
INFO    (22: 3:12:459 |    1)  15901; [remote:148.153.116.175:8443] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3:12:459 |    0)  15901; [remote:148.153.116.175:8443] receive server hello piece id: 1, 2/10, not complete
INFO    (22: 3:12:459 |    0)  15901; [remote:148.153.116.175:8443] receive server hello piece id: 2, 3/10, not complete
INFO    (22: 3:12:459 |    0)  15901; [remote:129.227.205.179:8130] start 1th connect, send client hello 12813586|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:464 |    5)  15901; [vocs/tcp] connected with 52.59.134.47:8443
INFO    (22: 3:12:464 |    0)  15901; [vocs] report bitrate: a/v/t: 50/400/450
INFO    (22: 3:12:464 |    0)  15901; [vocs] tcp - creating channel with 52.59.134.47:8443, ts 1618590792464.......
INFO    (22: 3:12:466 |    2)  15901; [remote:148.153.116.175:8443] receive server hello piece id: 3, 4/10, not complete
INFO    (22: 3:12:466 |    0)  15901; [remote:148.153.116.175:8443] receive server hello piece id: 4, 5/10, complete
INFO    (22: 3:12:477 |   11)  15901; [remote:148.153.116.175:8443] create connection 0x7080755400, self initial seq: 2090310, initial rtt: 251ms, git tag: Unknown, perspective: Perspective::kClient, cc: BBRv1, pacing: enable
INFO    (22: 3:12:477 |    0)  15901; [remote:148.153.116.175:8443] create session 0x70804fc600
INFO    (22: 3:12:478 |    1)  15901; [vocs/aut] connected with 148.153.116.175:8443
INFO    (22: 3:12:478 |    0)  15901; destroy dangling client connection 0x708433ec00
INFO    (22: 3:12:617 |  139)  15901; [vocs/u] **responsed from 128.1.78.146:8443, 3 vos, elapsed 2169, server ts 1618590793886, wan ip 103.******.166
INFO    (22: 3:12:618 |    1)  15901; [vos] vos list: 129.227.205.140:4017
INFO    (22: 3:12:618 |    0)  15901; [vos] added server: 129.227.205.140:4017
INFO    (22: 3:12:618 |    0)  15901; [vos] vos list: 129.227.205.83:4010
INFO    (22: 3:12:618 |    0)  15901; [vos] added server: 129.227.205.83:4010
INFO    (22: 3:12:618 |    0)  15901; [vos] vos list: 129.227.205.209:4009
INFO    (22: 3:12:618 |    0)  15901; [vos] added server: 129.227.205.209:4009
INFO    (22: 3:12:618 |    0)  15901; [ch0] vos initialized
INFO    (22: 3:12:619 |    1)  15901; [vos] selected: 129.227.205.209:4009
INFO    (22: 3:12:619 |    0)  15901; add ping address 103.240.233.166
INFO    (22: 3:12:619 |    0)  15901; PING 103.240.233.166:0 16(44) bytes of data
INFO    (22: 3:12:619 |    0)  15901; [remote:128.1.78.146:8443] destroy session 0x6ffc50fa80
INFO    (22: 3:12:620 |    1)  15901; [remote:128.1.78.146:8443] destroy connection 0x6ffc4c2c00
ERROR   (22: 3:12:621 |    1)  15901; [ch0] login strategy=2
INFO    (22: 3:12:621 |    0)  15901; [ds]: ver 1 ds '{"streamType":1}'
INFO    (22: 3:12:621 |    0)  15901; [che] getEngineCapabilities: 0:{0:COMMUNICATION,1:BROADCASTING,2:UNIFIED_COMMUNICATION}
INFO    (22: 3:12:621 |    0)  15901; [che] getEngineCapabilities: 1:{0:L16,1:G722,2:OPUS,3:OPUS2ch,4:SILK,5:NOVA,6:AACLC,7:AACLC2ch,8:HEAAC,9:HEAAC2ch,10:JC1,11:kHEAAC2ch_2,12:kHEAAC_2}
INFO    (22: 3:12:621 |    0)  15901; [che] getEngineCapabilities: 2:{0:EVP,1:VP8,2:E264,3:H264}
INFO    (22: 3:12:621 |    0)  15901; [che] getEngineCapabilities: 7:{0:AUDIORSFEC}
INFO    (22: 3:12:621 |    0)  15901; [ch0] Login VOS (proto:12, cid:3068706840, uid:2, ts:1618590792621, ticket size:88, detail size:432 ds:1 stream:+A-V encryption: 1) 1: 129.227.205.209:4009
INFO    (22: 3:12:662 |   41)  15901; [vocs/u] **responsed from 18.195.199.4:8443, 3 vos, elapsed 2214, server ts 1618590793934, wan ip 103.******.166
INFO    (22: 3:12:663 |    1)  15901; [vos] vos list: 129.227.205.100:4002
INFO    (22: 3:12:663 |    0)  15901; [vos] added server: 129.227.205.100:4002
INFO    (22: 3:12:663 |    0)  15901; [vos] vos list: 129.227.205.221:4016
INFO    (22: 3:12:663 |    0)  15901; [vos] added server: 129.227.205.221:4016
INFO    (22: 3:12:663 |    0)  15901; [vos] vos list: 128.1.120.146:4002
INFO    (22: 3:12:663 |    0)  15901; [vos] added server: 128.1.120.146:4002
INFO    (22: 3:12:663 |    0)  15901; [remote:18.195.199.4:8443] destroy session 0x6ffc511a00
INFO    (22: 3:12:664 |    1)  15901; [remote:18.195.199.4:8443] destroy connection 0x7007bbbe00
INFO    (22: 3:12:674 |   10)  15901; [cap] synchronise capability set with seq: 1
INFO    (22: 3:12:675 |    1)  15901; updateActiveVosList: ["129.227.205.209:4009"]
INFO    (22: 3:12:675 |    0)  15901; [cm] connection state changed from 2 to 3
INFO    (22: 3:12:676 |    1)  15901; [che] start call begins
INFO    (22: 3:12:676 |    0)  15901; opensl 0 android ver 29 banned level 22
INFO    (22: 3:12:676 |    0)  15901; reset objects active 1 opensl 0
INFO    (22: 3:12:676 |    0)  15901; prepareCall in
INFO    (22: 3:12:676 |    0)  15901; Update settings: mode 3, rec_source 7, rec_fs 16000, builtin aec 0
INFO    (22: 3:12:676 |    0)  15901; Set Application Mode in RTC Engine to No. 0 UC 0
INFO    (22: 3:12:676 |    0)  15901; SetCodec by type : No. 85, Channel 1
INFO    (22: 3:12:677 |    1)  15901; SetCodec by type : No. 85, Channel 1
ERROR   (22: 3:12:696 |   19)  15901; [AudioDevice Java] speaker
INFO    (22: 3:12:701 |    5)  15901; getScenarioHwaecConfig: scenario 7 role 2 route 1 hwApm 1
INFO    (22: 3:12:701 |    0)  15901; useInteractiveAdmParameters in: interactive 1
INFO    (22: 3:12:702 |    1)  15901; _startCall: called for the first time, scenario 7, mSpecMode 2, route_ 1, useHwAec 1
INFO    (22: 3:12:702 |    0)  15901; preselectAudioDevices in: enableBuildinAEC 1, audio.enableBuildinAEC 1, scenario 7, openSL 0, simulator 0, route 1, inputSR 16000 outputSR -1 stereoOut 0 audiomode 3 inputSRC 7 streamType 0
INFO    (22: 3:12:702 |    0)  15901; setupAudioMode in: audio_mode 3
INFO    (22: 3:12:702 |    0)  15980; [JNI] audioMode is set to 3
INFO    (22: 3:12:702 |    0)  15901; StartPlayout complete
INFO    (22: 3:12:702 |    0)  15901; getScenarioRecordConfig: scenario 7 audienceNeedRecord 1
INFO    (22: 3:12:702 |    0)  15901; StartSend
INFO    (22: 3:12:703 |    1)  15901; StartRecording complete
INFO    (22: 3:12:704 |    1)  15901; _startCall: audienceRecord 1, mWillsend 1, enableBuildinAEC 1(call volume), enableLocalAudio 1
INFO    (22: 3:12:704 |    0)  15901; getScenarioHwaecConfig: scenario 7 role 2 route 1 hwApm 1
INFO    (22: 3:12:704 |    0)  15901; _setAudioOutputRouting: called for the first time for scenario 7, mSpecMode 2: initial routing 1, previousUseHwAec 1, useHwAec 1, restartAdm 0
INFO    (22: 3:12:704 |    0)  15901; setAecType: aec is set to 3
ERROR   (22: 3:12:705 |    1)  15901; SetAgcConfig() failed to set the range in |gain| the digital compression stage may apply (error=8097)
INFO    (22: 3:12:705 |    0)  15901; SetHowlingControl enable = 0
INFO    (22: 3:12:705 |    0)  15901; SetBurstNoiseDetection enable = 0
INFO    (22: 3:12:705 |    0)  15901; _setAudioOutputRouting: Application Config module:  Route 1, NS on, AEC on, AGC off, MD off, HC on
INFO    (22: 3:12:705 |    0)  15901; _setAudioOutputRouting: MID = 195, Routing = 1
INFO    (22: 3:12:705 |    0)  15901; output: NOT_SUPPORTED
INFO    (22: 3:12:705 |    0)  15901;   Output: audioLayer=10
INFO    (22: 3:12:706 |    1)  15901; [che] start call returns 0, elapsed 30
INFO    (22: 3:12:706 |    0)  15901; [time] process EngineStartCall takes 30
INFO    (22: 3:12:706 |    0)  15901; join channel success: cname 'user:2' uid 2 elapsed 2257
INFO    (22: 3:12:707 |    1)  15901; CacheManager: save cache to storage elapsed 1
INFO    (22: 3:12:708 |    1)  15901; [ch0] **VOS encryption response to login request (res 0 elapsed 2259, server ts 1618590794025, s-c:1317) from 129.227.205.209:4009, and current dest server 129.227.205.209:4009
INFO    (22: 3:12:708 |    0)  15901; updateActiveVosList: ["129.227.205.209:4009"]
INFO    (22: 3:12:709 |    1)  15901; CacheManager: save cache to storage elapsed 0
INFO    (22: 3:12:709 |    0)  15901; [rp] publish audio old:0,new:2,elapsed:0
INFO    (22: 3:12:709 |    0)  15901; [API][rtc_engine_impl.cpp:5117][onMediaEngineEvent]
INFO    (22: 3:12:715 |    6)  15901; [API][rtc_engine_impl.cpp:5117][onMediaEngineEvent]
INFO    (22: 3:12:715 |    0)  15901; [vocs/t] **responsed from 52.59.134.47:8443, 3 vos, elapsed 2267, server ts 1618590793947, wan ip 103.******.166
INFO    (22: 3:12:716 |    1)  15901; [vos] vos list: 129.227.205.132:4007
INFO    (22: 3:12:716 |    0)  15901; [vos] added server: 129.227.205.132:4007
INFO    (22: 3:12:716 |    0)  15901; [vos] vos list: 129.227.205.80:4002
INFO    (22: 3:12:716 |    0)  15901; [vos] added server: 129.227.205.80:4002
INFO    (22: 3:12:716 |    0)  15901; [vos] vos list: 129.227.205.204:4017
INFO    (22: 3:12:716 |    0)  15901; [vos] added server: 129.227.205.204:4017
WARN    (22: 3:12:716 |    0)  15901; ahpl_close failed with error=9
INFO    (22: 3:12:721 |    5)  15901; [vocs/u] **responsed from 148.153.116.175:8443, 3 vos, elapsed 2272, server ts 1618590793975, wan ip 103.******.166
INFO    (22: 3:12:721 |    0)  15901; [vos] vos list: 129.227.205.145:4006
INFO    (22: 3:12:721 |    0)  15901; [vos] added server: 129.227.205.145:4006
INFO    (22: 3:12:721 |    0)  15901; [vos] vos list: 129.227.205.87:4010
INFO    (22: 3:12:721 |    0)  15901; [vos] added server: 129.227.205.87:4010
INFO    (22: 3:12:721 |    0)  15901; [vos] vos list: 129.227.205.201:4002
INFO    (22: 3:12:721 |    0)  15901; [vos] added server: 129.227.205.201:4002
INFO    (22: 3:12:721 |    0)  15901; [remote:148.153.116.175:8443] destroy session 0x70804fc600
INFO    (22: 3:12:722 |    1)  15901; [remote:148.153.116.175:8443] destroy connection 0x7080755400
INFO    (22: 3:12:765 |   43)  15901; [ch0] rtt: 58
INFO    (22: 3:12:766 |    1)  15980; [JNI] InitSampleRate Recording 16000
INFO    (22: 3:12:766 |    0)  15980; [JNI] InitSampleRate playout 48000 , res = 48000
INFO    (22: 3:12:766 |    0)  15980; [JNI] FindSupportedPlayoutSampleRate streamtype 0
INFO    (22: 3:12:794 |   28)  15980; [JNI] playback sample rate is set to (48000)
INFO    (22: 3:12:815 |   21)  15901; [API][rtc_engine_impl.cpp:5117][onMediaEngineEvent]
INFO    (22: 3:12:839 |   24)  15980; [JNI] InitSampleRate Recording 16000
INFO    (22: 3:12:839 |    0)  15980; [JNI] recording device is set to 7
INFO    (22: 3:12:841 |    2)  15901; [remote:129.227.205.198:8130] start 2th connect, send client hello 8426920|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:874 |   33)  15901; [cap] synchronise capability set with seq: 1
INFO    (22: 3:12:921 |   47)  15901; [remote:129.227.205.179:8130] start 2th connect, send client hello 12813586|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:12:933 |   12)  15901; [cap] Received capability set ack seq: 1
ERROR   (22: 3:12:997 |   64)  15984; [AudioDevice Java] caculated the first render TS = 182 pos = 80ms delay 282
ERROR   (22: 3:13: 59 |    0)  15980; [AudioDevice Java] AcousticEchoCanceler.getEnabled: false
INFO    (22: 3:13: 59 |    0)  15980; [JNI] recording sample rate is set to (16000)
ERROR   (22: 3:13: 73 |   14)  15980; [AudioDevice Java] Recording start time 126009593874197
INFO    (22: 3:13: 75 |    2)  15980; SetLocalState: state 1 error 0
INFO    (22: 3:13: 75 |    0)  15980; [AudioDevice Java] enableHardwareEarback false
INFO    (22: 3:13: 75 |    0)  15980; [AudioDevice Java] enableHardwareEarback false ret -7
INFO    (22: 3:13:148 |   73)  15983; [AudioDevice Java] frames  960 recDelay 76 caculated frames delay 60
INFO    (22: 3:13:148 |    0)  15983; SetLocalState: state 2 error 0
INFO    (22: 3:13:149 |    1)  15901; TRACER: onFirstLocalAudioFrame codec 85 elapsed 2700
INFO    (22: 3:13:149 |    0)  15901; TRACER: onFirstLocalAudioFramePublished codec 85 elapsed 2700
INFO    (22: 3:13:149 |    0)  15901; [rp] publish audio old:2,new:3,elapsed:473
INFO    (22: 3:13:549 |  400)  15901; [remote:129.227.205.179:8130] start 3th connect, send client hello 12813586|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:13:734 |  185)  15901; [remote:129.227.205.198:8130] start 3th connect, send client hello 8426920|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:15: 79 |    0)  15901; [remote:129.227.205.198:8130] start 4th connect, send client hello 8426920|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:15:176 |   97)  15901; [remote:129.227.205.198:8130] receive server hello piece id: 4, 1/10, not complete
INFO    (22: 3:15:176 |    0)  15901; [remote:129.227.205.198:8130] receive server hello piece id: 0, 2/10, not complete
INFO    (22: 3:15:176 |    0)  15901; [remote:129.227.205.198:8130] receive server hello piece id: 1, 3/10, not complete
INFO    (22: 3:15:176 |    0)  15901; [remote:129.227.205.198:8130] receive server hello piece id: 2, 4/10, not complete
INFO    (22: 3:15:177 |    1)  15901; [remote:129.227.205.198:8130] receive server hello piece id: 5, 5/10, complete
INFO    (22: 3:15:206 |   29)  15901; [remote:129.227.205.198:8130] create connection 0x7080755400, self initial seq: 8426921, initial rtt: 2960ms, git tag: Unknown, perspective: Perspective::kClient, cc: BBRv1, pacing: enable
INFO    (22: 3:15:207 |    1)  15901; [remote:129.227.205.198:8130] create session 0x701e70dc00
INFO    (22: 3:15:207 |    0)  15901; [rs] link aut to 129.227.205.198:8130 connected
INFO    (22: 3:15:207 |    0)  15901; destroy dangling client connection 0x708420d800
INFO    (22: 3:15:309 |  102)  15901; [remote:129.227.205.179:8130] start 4th connect, send client hello 12813586|syn, tags: SNI :3132392d3232...(29), PDMD:, CPTO:4e4f4e432000...(129)
WARN    (22: 3:16:710 |  401)  15983; captured signal all 0s
WARN    (22: 3:16:710 |    0)  15983; audio device captured signal all 0s
INFO    (22: 3:16:711 |    1)  15903; [API][rtc_engine_impl.cpp:991][getParameters]
INFO    (22: 3:16:711 |    0)  15901; [rp] ["che.audio.adm.active"]
INFO    (22: 3:16:711 |    0)  15901; [rp] res: {"che.audio.adm.active":1} 
WARN    (22: 3:17:136 |    0)  15983; captured signal too small
WARN    (22: 3:17:136 |    0)  15983; audio device captured signal too small
INFO    (22: 3:17:241 |  105)  15901; create session builder 0x70804fc600
INFO    (22: 3:17:241 |    0)  15901; destroy dangling client connection 0x708433e000
INFO    (22: 3:17:242 |    1)  15901; create dangling client connection 0x708433e000
INFO    (22: 3:17:275 |   33)  15901; [remote:129.227.156.4:8130] start 0th connect, send client hello 10896635|syn, tags: SNI :3132392d3232...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:17:371 |   96)  15901; [remote:129.227.205.198:8130] path MTU to remote increased: 1280 --> 1365
INFO    (22: 3:17:371 |    0)  15901; [remote:129.227.205.198:8130] on max stream frame length changed from 1204 to 1339
INFO    (22: 3:17:472 |  101)  15901; [remote:129.227.156.4:8130] start 1th connect, send client hello 10896635|syn, tags: SNI :3132392d3232...(27), PDMD:, CPTO:4e4f4e432000...(129)
INFO    (22: 3:17:578 |  106)  15901; [remote:129.227.156.4:8130] receive server hello piece id: 0, 1/10, not complete
INFO    (22: 3:17:578 |    0)  15901; [remote:129.227.156.4:8130] receive server hello piece id: 1, 2/10, not complete
INFO    (22: 3:17:578 |    0)  15901; [remote:129.227.156.4:8130] receive server hello piece id: 2, 3/10, not complete
INFO    (22: 3:17:578 |    0)  15901; [remote:129.227.156.4:8130] receive server hello piece id: 3, 4/10, not complete
INFO    (22: 3:17:578 |    0)  15901; [remote:129.227.156.4:8130] receive server hello piece id: 4, 5/10, complete
INFO    (22: 3:17:608 |   30)  15901; [remote:129.227.156.4:8130] create connection 0x6ffc4c2c00, self initial seq: 10896636, initial rtt: 334ms, git tag: Unknown, perspective: Perspective::kClient, cc: BBRv1, pacing: enable
INFO    (22: 3:17:608 |    0)  15901; [remote:129.227.156.4:8130] create session 0x701e70d900
INFO    (22: 3:17:608 |    0)  15901; [rs] link aut to 129.227.156.4:8130 connected
INFO    (22: 3:17:608 |    0)  15901; destroy dangling client connection 0x708433e000
WARN    (22: 3:18:714 |  106)  15983; captured signal all 0s
WARN    (22: 3:18:715 |    1)  15983; audio device captured signal all 0s
INFO    (22: 3:18:715 |    0)  15983; Audio statistics - rec count: record count = 200 signal level: near_in = 0, near_out = 0 farin = 0
INFO    (22: 3:18:716 |    1)  15903; [API][rtc_engine_impl.cpp:991][getParameters]
INFO    (22: 3:18:716 |    0)  15901; [rp] ["che.audio.adm.active"]
INFO    (22: 3:18:716 |    0)  15901; [rp] res: {"che.audio.adm.active":1} 
INFO    (22: 3:18:836 |  120)  15984; Audio statistics - play count: playout count = 204  signal level: far_in = 0
WARN    (22: 3:19:130 |    0)  15983; captured signal too small
WARN    (22: 3:19:130 |    0)  15983; audio device captured signal too small
WARN    (22: 3:20:715 |  585)  15983; captured signal all 0s
WARN    (22: 3:20:716 |    1)  15983; audio device captured signal all 0s
INFO    (22: 3:20:717 |    1)  15903; [API][rtc_engine_impl.cpp:991][getParameters]
INFO    (22: 3:20:717 |    0)  15901; [rp] ["che.audio.adm.active"]
INFO    (22: 3:20:717 |    0)  15901; [rp] res: {"che.audio.adm.active":1} 
INFO    (22: 3:20:770 |   53)  15901; [remote:129.227.205.198:8130] path MTU to remote increased: 1365 --> 1415
INFO    (22: 3:20:770 |    0)  15901; [remote:129.227.205.198:8130] on max stream frame length changed from 1339 to 1389
WARN    (22: 3:21:136 |    0)  15983; captured signal too small
WARN    (22: 3:21:137 |    1)  15983; audio device captured signal too small
WARN    (22: 3:23:132 |    0)  15983; captured signal too small
WARN    (22: 3:23:132 |    0)  15983; audio device captured signal too small
WARN    (22: 3:25:130 |    0)  15983; captured signal too small
WARN    (22: 3:25:130 |    0)  15983; audio device captured signal too small
WARN    (22: 3:26:727 |  597)  15983; captured signal all 0s
WARN    (22: 3:26:727 |    0)  15983; audio device captured signal all 0s
INFO    (22: 3:26:731 |    4)  15903; [API][rtc_engine_impl.cpp:991][getParameters]
INFO    (22: 3:26:731 |    0)  15901; [rp] ["che.audio.adm.active"]
INFO    (22: 3:26:731 |    0)  15901; [rp] res: {"che.audio.adm.active":1} 
WARN    (22: 3:27:136 |    0)  15983; captured signal too small
WARN    (22: 3:27:136 |    0)  15983; audio device captured signal too small
INFO    (22: 3:28:282 |  146)  15901; [remote:129.227.156.4:8130] path MTU to remote increased: 1280 --> 1365
INFO    (22: 3:28:283 |    1)  15901; [remote:129.227.156.4:8130] on max stream frame length changed from 1204 to 1339
WARN    (22: 3:29:136 |    0)  15983; captured signal too small
WARN    (22: 3:29:136 |    0)  15983; audio device captured signal too small
WARN    (22: 3:31:135 |    0)  15983; captured signal too small
WARN    (22: 3:31:136 |    1)  15983; audio device captured signal too small
WARN    (22: 3:32:728 |  592)  15983; captured signal all 0s
WARN    (22: 3:32:728 |    0)  15983; audio device captured signal all 0s
INFO    (22: 3:32:728 |    0)  15983; Audio statistics - rec count: record count = 600 signal level: near_in = 0, near_out = 0 farin = 0
INFO    (22: 3:32:729 |    1)  15903; [API][rtc_engine_impl.cpp:991][getParameters]
INFO    (22: 3:32:729 |    0)  15901; [rp] ["che.audio.adm.active"]
INFO    (22: 3:32:729 |    0)  15901; [rp] res: {"che.audio.adm.active":1} 
INFO    (22: 3:32:877 |  148)  15984; Audio statistics - play count: playout count = 600  signal level: far_in = 0
WARN    (22: 3:33:132 |    0)  15983; captured signal too small
WARN    (22: 3:33:132 |    0)  15983; audio device captured signal too small
WARN    (22: 3:35:131 |    0)  15983; captured signal too small
WARN    (22: 3:35:131 |    0)  15983; audio device captured signal too small
WARN    (22: 3:37:130 |    0)  15983; captured signal too small
WARN    (22: 3:37:130 |    0)  15983; audio device captured signal too small
INFO    (22: 3:38:401 |  271)  15901; [remote:129.227.156.4:8130] path MTU to remote increased: 1365 --> 1415
INFO    (22: 3:38:401 |    0)  15901; [remote:129.227.156.4:8130] on max stream frame length changed from 1339 to 1389
WARN    (22: 3:38:731 |  330)  15983; captured signal all 0s
WARN    (22: 3:38:731 |    0)  15983; audio device captured signal all 0s
INFO    (22: 3:38:732 |    1)  15903; [API][rtc_engine_impl.cpp:991][getParameters]
INFO    (22: 3:38:732 |    0)  15901; [rp] ["che.audio.adm.active"]
INFO    (22: 3:38:732 |    0)  15901; [rp] res: {"che.audio.adm.active":1} 
WARN    (22: 3:39:131 |    0)  15983; captured signal too small
WARN    (22: 3:39:131 |    0)  15983; audio device captured signal too small
WARN    (22: 3:41:129 |    0)  15983; captured signal too small
WARN    (22: 3:41:129 |    0)  15983; audio device captured signal too small
INFO    (22: 3:41:393 |  264)  15314; [API][rtc_engine_impl.cpp:604][leaveChannel]
INFO    (22: 3:41:393 |    0)  15314; API call to leave channel user:2
INFO    (22: 3:41:393 |    0)  15314; [AudioRoute] Monitor stop state, reset
INFO    (22: 3:41:394 |    1)  15314; [AudioRoute] Monitor stopped
INFO    (22: 3:41:394 |    0)  15314; [API][rtc_engine_impl.cpp:2837][clearVideoWatermarks]
INFO    (22: 3:41:394 |    0)  15901; [API][rtc_engine_impl.cpp:980][setParameters]
INFO    (22: 3:41:395 |    1)  15901; [cm] emit leave channel signal
INFO    (22: 3:41:395 |    0)  15314; [API][rtc_engine_impl.cpp:2452][updateVideoSourceType]
INFO    (22: 3:41:395 |    0)  15314; Detach external video source from pipeline
INFO    (22: 3:41:395 |    0)  15314; android destroyEngine
INFO    (22: 3:41:395 |    0)  15314; [API][rtc_engine_impl.cpp:3577][release]
INFO    (22: 3:41:458 |   63)  15901; [rs] **report stats: seq: 72, report list size 3, tx/rx: 12510/3312, cache size: 0
INFO    (22: 3:41:458 |    0)  15901; [rs] report server1: 129.227.205.198:8130
INFO    (22: 3:41:458 |    0)  15901; [che] stopCall begins
INFO    (22: 3:41:458 |    0)  15901; stopCall in
INFO    (22: 3:41:458 |    0)  15901; StopRecording complete
INFO    (22: 3:41:458 |    0)  15901; SetLocalState: state 0 error 0
INFO    (22: 3:41:458 |    0)  15901; StopRecording complete
INFO    (22: 3:41:458 |    0)  15901; StopPlayout complete
INFO    (22: 3:41:459 |    1)  15901; setAecType: aec is set to 5
INFO    (22: 3:41:459 |    0)  15901; [che] stop call returns 0, elapsed 1
INFO    (22: 3:41:459 |    0)  15901; [time] process EngineStopCall takes 1
INFO    (22: 3:41:533 |   74)  15980; [JNI] audioMode is set to 0
INFO    (22: 3:41:622 |   89)  15901; [time] process EngineSyncDevice takes 163
ERROR   (22: 3:41:622 |    0)  15984; PlayAudio failed (-2)
INFO    (22: 3:41:623 |    1)  15901; [cm] connection state changed from 3 to 1
INFO    (22: 3:41:623 |    0)  15901; **CALL STATS: duration 30s, tx 206.21K bytes, rx 102.467K bytes, total 308.488K bytes
INFO    (22: 3:41:628 |    5)  15901; CacheManager: save cache to storage elapsed 4
INFO    (22: 3:41:630 |    2)  15901; [ch0] vos destroyed
INFO    (22: 3:41:631 |    1)  15901; delRef of media engine, ref=0
INFO    (22: 3:41:631 |    0)  15901; [che] chat engine destroying
INFO    (22: 3:41:631 |    0)  15901; [che] stopCall begins
INFO    (22: 3:41:631 |    0)  15901; [che] stop call returns -1, elapsed 1
INFO    (22: 3:41:632 |    1)  15980; [AudioDevice Java] enableHardwareEarback false
INFO    (22: 3:41:632 |    0)  15980; [AudioDevice Java] enableHardwareEarback false ret -7
ERROR   (22: 3:41:635 |    3)  15901; AsyncAudioDevice destructed, counter: 0

WARN    (22: 3:41:635 |    0)  15901; VoiceEngine::SetAndroidObjects engine context 0
INFO    (22: 3:41:635 |    0)  15901; opensl 0 android ver 29 banned level 22 scenario 7 androidHighQualitySLEnable 0
WARN    (22: 3:41:635 |    0)  15901; VoiceEngine::SetAndroidObjects engine context 176
INFO    (22: 3:41:635 |    0)  15901; [che] chat engine destroyed
INFO    (22: 3:41:635 |    0)  15901; ***CALL END
INFO    (22: 3:41:635 |    0)  15901; onAudioStatusChanged enable audio
INFO    (22: 3:41:635 |    0)  15901; [rp] {"che.video.watermark":{"type":0}}
INFO    (22: 3:41:645 |   10)  15901; [CommonUtility] [disableOrientationListener] done!
INFO    (22: 3:41:646 |    1)  15901; [CommonUtility] [unregisterBroadcaster] done!
INFO    (22: 3:41:646 |    0)  15901; [CommonUtility] [destroy] done!
INFO    (22: 3:41:648 |    2)  15901; [API][rtc_engine_impl.cpp:1281][stopService]
INFO    (22: 3:41:650 |    2)  15901; [MIO] media io controller destroyed
INFO    (22: 3:41:671 |   21)  15901; [API][rtc_engine_impl.cpp:1281][stopService]
plutoless commented 3 years ago

INFO (22: 3:10:493 | 1) 15901; [MediaCodec Audio Decoder] Try to decode audio file : https://our-website.com/sounds/call_warning.mp3 ERROR (22: 3:11:343 | 0) 15901; [MediaCodec Audio Decoder] Connect timeout on URL : https://our-website.com/sounds/call_warning.mp3

it seems the connection failed. i checked the link in browser, the site has some issues with its certificate. can you try another url which has a proper certificate, while at same time can be accessed in same network?

rmj-s commented 3 years ago

Hi @plutoless, I've redacted the original URL, I can email it to you if you need it. It happens constantly at random times and then resolves on its own. The URL works fine in the browser at the same time.

plutoless commented 3 years ago

zqz@ZQZdeMacBook-Pro ad-continuous % curl https://our-website.com/sounds/call_warning.mp3 curl: (60) SSL certificate problem: certificate has expired More details here: https://curl.haxx.se/docs/sslcerts.html

curl failed to verify the legitimacy of the server and therefore could not establish a secure connection to it. To learn more about this situation and how to fix it, please visit the web page mentioned above.

@rmj-s here's the testing result for curl. the certificate of this website has problems.

rmj-s commented 3 years ago

here's the testing result for curl. the certificate of this website has problems.

I've replaced the original domain in the log with https://our-website.com, the original URL is https://api.welistenyou.com/sounds/call_warning.mp3

LichKing-2234 commented 3 years ago

here's the testing result for curl. the certificate of this website has problems.

I've replaced the original domain in the log with https://our-website.com, the original URL is https://api.welistenyou.com/sounds/call_warning.mp3

Is the issue still exist?

lohnsonok commented 3 years ago

Not working for me too

LichKing-2234 commented 3 years ago

@lohnsonok pls provide the SDK log.

github-actions[bot] commented 2 years ago

Without additional information, we are unfortunately not sure how to resolve this issue. We are therefore reluctantly going to close this bug for now. If you find this problem please file a new issue with the same description, what happens, logs and the output. All system setups can be slightly different so it's always better to open new issues and reference the related ones. Thanks for your contribution.

github-actions[bot] commented 1 year ago

This thread has been automatically locked since there has not been any recent activity after it was closed. If you are still experiencing a similar issue, please raise a new issue.