No video or audio self hosted

adminblackwood · May 2, 2022, 7:51pm

We have a fresh install of Jitsi Meet. The installation works when connecting multiple devices from the home local network. When a meeting is joined from anywhere else it disables the audio and video of everyone in the room. I have searched and read the related topics.

The self hosted installation is on the following dedicated server.

Processor: Intel Xeon E3-1230 v6 Quad-Core
OS: Linux OS
    (+Apache)
    (+Ubuntu 20.04 LTS 64-bit)
ControlPanel: No Control Panel - Core Managed
RAM: 16GB DDR4 SDRAM
HD1: 2 x SSD    (+240 GB SSD)    (+Software RAID 1)
HD2: Single SATA HDD (7,200 RPM)    (+2 TB SATA HDD (7,200 RPM))
DDOSProtection: Standard DDoS Attack Protection (up to 2gbps)

I have verified port 10000 is open.

root@dreaming ~]# ngrep -q 'is accessable' udp port 10000
interface: eno1 (67.225.224.0/255.255.254.0)
filter: ( udp port 10000 ) and ((ip || ip6) || (vlan && (ip || ip6)))
match: is accessable

U 69.16.201.4:52088 -> 67.225.224.214:10000 #1
  yes, it is accessable.

U 69.16.201.4:39307 -> 67.225.224.214:10000 #2
  yes, it is accessable.
^C[root@dreaming ~]#

Here is the contents of jvb.log while a meeting is experiencing the issue.

JVB 2022-05-02 11:39:39.758 WARNING: [54] [confId=24ad4a73a5bb2db2 gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Conference.lambda$new$0#306: Took 605 ms to process an IQ (total delay 629 ms): <iq xmlns='jabber:client' to='jvb@auth.dreaming.hashtag.space/KrbASDz6rKk_' from='jvbbrewery@internal.auth.dreaming.hashtag.space/focus' id='anZiQGF1dGguZHJlYW1pbmcuaGFzaHRhZy5zcGFjZS9LcmJBU0R6NnJLa18ATkpaWUYtOQDFxVvDL5BmDw==' type='get'><conference-modify xmlns='jitsi:colibri2' meeting-id='8b02b072-5730-43fd-8260-c621b7be7ba6' name='gonefishing@conference.dreaming.hashtag.space' rtcstats-enabled='false' callstats-enabled='false' create='true'><endpoint xmlns='jitsi:colibri2' create='true' id='168c643f' stats-id='Marisa-mnd'><media type='audio'><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' clockrate='48000' channels='2' id='111' name='opus'><parameter value='10' name='minptime'/><parameter value='1' name='useinbandfec'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='transport-cc'/></payload-type><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='103' clockrate='16000' name='ISAC'/><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='104' clockrate='32000' name='ISAC'/><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='126' clockrate='8000' name='telephone-event'/><rtp-hdrext xmlns='urn:xmpp:jingle:apps:rtp:rtp-hdrext:0' id='1' uri='urn:ietf:params:rtp-hdrext:ssrc-audio-level'/><rtp-hdrext xmlns='urn:xmpp:jingle:apps:rtp:rtp-hdrext:0' id='5' uri='http://www.ietf.org/id/draft-holmer-rmcat-transport-wide-cc-extensions-01'/></media><media type='video'><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='100' clockrate='90000' name='VP8'><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='ccm' subtype='fir'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack' subtype='pli'/><parameter value='800' name='x-google-start-bitrate'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='transport-cc'/></payload-type><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='107' clockrate='90000' name='H264'><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='ccm' subtype='fir'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack' subtype='pli'/><parameter value='800' name='x-google-start-bitrate'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='transport-cc'/><parameter value='42e01f;level-asymmetry-allowed=1;packetization-mode=1;' name='profile-level-id'/></payload-type><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='101' clockrate='90000' name='VP9'><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='ccm' subtype='fir'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack' subtype='pli'/><parameter value='800' name='x-google-start-bitrate'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='transport-cc'/></payload-type><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='96' clockrate='90000' name='rtx'><parameter value='100' name='apt'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='ccm' subtype='fir'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack' subtype='pli'/></payload-type><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='97' clockrate='90000' name='rtx'><parameter value='101' name='apt'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='ccm' subtype='fir'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack'/><rtcp-fb xmlns='urn:xmpp:jingle:apps:rtp:rtcp-fb:0' type='nack' subtype='pli'/></payload-type><payload-type xmlns='urn:xmpp:jingle:apps:rtp:1' id='99' clockrate='90000' name='rtx'><parameter value='107' name='apt'/></payload-type><rtp-hdrext xmlns='urn:xmpp:jingle:apps:rtp:rtp-hdrext:0' id='3' uri='http://www.webrtc.org/experiments/rtp-hdrext/abs-send-time'/><rtp-hdrext xmlns='urn:xmpp:jingle:apps:rtp:rtp-hdrext:0' id='5' uri='http://www.ietf.org/id/draft-holmer-rmcat-transport-wide-cc-extensions-01'/></media><transport ice-controlling='true'><sctp/></transport></endpoint></conference-modify></iq>
JVB 2022-05-02 11:39:39.760 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=72aa01g22mqobf gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf] Agent.gatherCandidates#644: Gathering candidates for component stream-f5f2a84f.RTP.
JVB 2022-05-02 11:39:39.764 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.<init>#293: Created new endpoint isUsingSourceNames=false, iceControlling=true
JVB 2022-05-02 11:39:39.982 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:39:39.989 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=e5tp11g22mqnpe gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:39:39.990 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe epId=168c643f local_ufrag=e5tp11g22mqnpe] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:39:39.990 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe epId=168c643f local_ufrag=e5tp11g22mqnpe] Agent.initCheckLists#969: Init checklist for stream stream-168c643f
JVB 2022-05-02 11:39:39.991 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe epId=168c643f local_ufrag=e5tp11g22mqnpe] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:39:39.991 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=e5tp11g22mqnpe gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:39:39.991 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe epId=168c643f local_ufrag=e5tp11g22mqnpe] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:39:40.135 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe name=stream-168c643f epId=168c643f local_ufrag=e5tp11g22mqnpe] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-168c643f.RTP: 10.100.10.196:49211/udp
JVB 2022-05-02 11:39:40.135 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe name=stream-168c643f epId=168c643f local_ufrag=e5tp11g22mqnpe] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 10.100.10.196:49211/udp/host (stream-168c643f.RTP).
JVB 2022-05-02 11:39:40.155 WARNING: [62] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe epId=168c643f local_ufrag=e5tp11g22mqnpe] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0xFA626D858001E46027301327]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->10.100.10.196:49211/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:39:40.156 INFO: [62] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe epId=168c643f local_ufrag=e5tp11g22mqnpe] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 10.100.10.196:49211/udp/host (stream-168c643f.RTP)
JVB 2022-05-02 11:39:41.250 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:39:41.251 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=72aa01g22mqobf gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:39:41.251 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf epId=f5f2a84f local_ufrag=72aa01g22mqobf] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:39:41.251 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf epId=f5f2a84f local_ufrag=72aa01g22mqobf] Agent.initCheckLists#969: Init checklist for stream stream-f5f2a84f
JVB 2022-05-02 11:39:41.251 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf epId=f5f2a84f local_ufrag=72aa01g22mqobf] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:39:41.252 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=72aa01g22mqobf gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:39:41.252 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf epId=f5f2a84f local_ufrag=72aa01g22mqobf] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:39:41.440 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf name=stream-f5f2a84f epId=f5f2a84f local_ufrag=72aa01g22mqobf] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-f5f2a84f.RTP: 192.168.1.65:51268/udp
JVB 2022-05-02 11:39:41.441 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf name=stream-f5f2a84f epId=f5f2a84f local_ufrag=72aa01g22mqobf] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 192.168.1.65:51268/udp/host (stream-f5f2a84f.RTP).
JVB 2022-05-02 11:39:41.455 WARNING: [62] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf epId=f5f2a84f local_ufrag=72aa01g22mqobf] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0x0F686D858001066A53367193]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->192.168.1.65:51268/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:39:41.455 INFO: [62] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf epId=f5f2a84f local_ufrag=72aa01g22mqobf] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 192.168.1.65:51268/udp/host (stream-f5f2a84f.RTP)
JVB 2022-05-02 11:39:46.286 INFO: [22] HealthChecker.run#171: Performed a successful health check in PT0.000009S. Sticky failure: false
JVB 2022-05-02 11:39:46.341 INFO: [27] VideobridgeExpireThread.expire#140: Running expire()
JVB 2022-05-02 11:39:56.287 INFO: [22] HealthChecker.run#171: Performed a successful health check in PT0.00001S. Sticky failure: false
JVB 2022-05-02 11:39:57.131 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] AbstractEndpoint.expire#316: Expiring.
JVB 2022-05-02 11:39:57.134 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1070: Spent 0 seconds oversending
JVB 2022-05-02 11:39:57.134 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Transceiver.teardown#348: Tearing down
JVB 2022-05-02 11:39:57.134 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpReceiverImpl.tearDown#344: Tearing down
JVB 2022-05-02 11:39:57.134 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpSenderImpl.tearDown#314: Tearing down
JVB 2022-05-02 11:39:57.136 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.stop#186: Stopping
JVB 2022-05-02 11:39:57.136 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=e5tp11g22mqnpe gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.stop#251: Stopping
JVB 2022-05-02 11:39:57.137 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe epId=168c643f local_ufrag=e5tp11g22mqnpe] Agent.setState#943: ICE state changed from Running to Terminated.
JVB 2022-05-02 11:39:57.137 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=e5tp11g22mqnpe name=stream-168c643f epId=168c643f local_ufrag=e5tp11g22mqnpe] MergingDatagramSocket.close#142: Closing.
JVB 2022-05-02 11:39:57.138 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1088: Expired.
JVB 2022-05-02 11:39:57.139 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=5b9gk1g22mr9ai gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai] Agent.gatherCandidates#644: Gathering candidates for component stream-168c643f.RTP.
JVB 2022-05-02 11:39:57.142 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.<init>#293: Created new endpoint isUsingSourceNames=false, iceControlling=true
JVB 2022-05-02 11:39:57.421 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:39:57.422 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=5b9gk1g22mr9ai gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:39:57.422 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai epId=168c643f local_ufrag=5b9gk1g22mr9ai] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:39:57.422 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai epId=168c643f local_ufrag=5b9gk1g22mr9ai] Agent.initCheckLists#969: Init checklist for stream stream-168c643f
JVB 2022-05-02 11:39:57.423 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai epId=168c643f local_ufrag=5b9gk1g22mr9ai] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:39:57.423 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=5b9gk1g22mr9ai gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:39:57.423 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai epId=168c643f local_ufrag=5b9gk1g22mr9ai] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:39:57.572 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai name=stream-168c643f epId=168c643f local_ufrag=5b9gk1g22mr9ai] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-168c643f.RTP: 10.100.10.196:57181/udp
JVB 2022-05-02 11:39:57.573 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai name=stream-168c643f epId=168c643f local_ufrag=5b9gk1g22mr9ai] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 10.100.10.196:57181/udp/host (stream-168c643f.RTP).
JVB 2022-05-02 11:39:57.587 WARNING: [62] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai epId=168c643f local_ufrag=5b9gk1g22mr9ai] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0x13A76D858001F9993DF1D7D3]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->10.100.10.196:57181/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:39:57.587 INFO: [62] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai epId=168c643f local_ufrag=5b9gk1g22mr9ai] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 10.100.10.196:57181/udp/host (stream-168c643f.RTP)
JVB 2022-05-02 11:39:58.473 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] AbstractEndpoint.expire#316: Expiring.
JVB 2022-05-02 11:39:58.473 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1070: Spent 0 seconds oversending
JVB 2022-05-02 11:39:58.474 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Transceiver.teardown#348: Tearing down
JVB 2022-05-02 11:39:58.474 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] RtpReceiverImpl.tearDown#344: Tearing down
JVB 2022-05-02 11:39:58.474 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] RtpSenderImpl.tearDown#314: Tearing down
JVB 2022-05-02 11:39:58.474 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.stop#186: Stopping
JVB 2022-05-02 11:39:58.474 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=72aa01g22mqobf gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.stop#251: Stopping
JVB 2022-05-02 11:39:58.474 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf epId=f5f2a84f local_ufrag=72aa01g22mqobf] Agent.setState#943: ICE state changed from Running to Terminated.
JVB 2022-05-02 11:39:58.475 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=72aa01g22mqobf name=stream-f5f2a84f epId=f5f2a84f local_ufrag=72aa01g22mqobf] MergingDatagramSocket.close#142: Closing.
JVB 2022-05-02 11:39:58.475 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1088: Expired.
JVB 2022-05-02 11:39:58.477 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=fhn881g22mrakc gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc] Agent.gatherCandidates#644: Gathering candidates for component stream-f5f2a84f.RTP.
JVB 2022-05-02 11:39:58.479 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.<init>#293: Created new endpoint isUsingSourceNames=false, iceControlling=true
JVB 2022-05-02 11:39:58.893 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:39:58.894 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=fhn881g22mrakc gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:39:58.894 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc epId=f5f2a84f local_ufrag=fhn881g22mrakc] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:39:58.894 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc epId=f5f2a84f local_ufrag=fhn881g22mrakc] Agent.initCheckLists#969: Init checklist for stream stream-f5f2a84f
JVB 2022-05-02 11:39:58.894 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc epId=f5f2a84f local_ufrag=fhn881g22mrakc] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:39:58.894 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=fhn881g22mrakc gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:39:58.894 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc epId=f5f2a84f local_ufrag=fhn881g22mrakc] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:39:59.055 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc name=stream-f5f2a84f epId=f5f2a84f local_ufrag=fhn881g22mrakc] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-f5f2a84f.RTP: 192.168.1.65:58816/udp
JVB 2022-05-02 11:39:59.056 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc name=stream-f5f2a84f epId=f5f2a84f local_ufrag=fhn881g22mrakc] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 192.168.1.65:58816/udp/host (stream-f5f2a84f.RTP).
JVB 2022-05-02 11:39:59.059 WARNING: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc epId=f5f2a84f local_ufrag=fhn881g22mrakc] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0xD2AC6D8580015AC4CA1E6DD7]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->192.168.1.65:58816/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:39:59.060 INFO: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc epId=f5f2a84f local_ufrag=fhn881g22mrakc] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 192.168.1.65:58816/udp/host (stream-f5f2a84f.RTP)
JVB 2022-05-02 11:40:06.286 INFO: [22] HealthChecker.run#171: Performed a successful health check in PT0.000012S. Sticky failure: false
JVB 2022-05-02 11:40:14.643 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] AbstractEndpoint.expire#316: Expiring.
JVB 2022-05-02 11:40:14.644 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1070: Spent 0 seconds oversending
JVB 2022-05-02 11:40:14.644 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Transceiver.teardown#348: Tearing down
JVB 2022-05-02 11:40:14.645 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpReceiverImpl.tearDown#344: Tearing down
JVB 2022-05-02 11:40:14.645 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpSenderImpl.tearDown#314: Tearing down
JVB 2022-05-02 11:40:14.646 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.stop#186: Stopping
JVB 2022-05-02 11:40:14.646 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=5b9gk1g22mr9ai gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.stop#251: Stopping
JVB 2022-05-02 11:40:14.646 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai epId=168c643f local_ufrag=5b9gk1g22mr9ai] Agent.setState#943: ICE state changed from Running to Terminated.
JVB 2022-05-02 11:40:14.647 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5b9gk1g22mr9ai name=stream-168c643f epId=168c643f local_ufrag=5b9gk1g22mr9ai] MergingDatagramSocket.close#142: Closing.
JVB 2022-05-02 11:40:14.647 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1088: Expired.
JVB 2022-05-02 11:40:14.650 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=4jml71g22mrqdo gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo] Agent.gatherCandidates#644: Gathering candidates for component stream-168c643f.RTP.
JVB 2022-05-02 11:40:14.655 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.<init>#293: Created new endpoint isUsingSourceNames=false, iceControlling=true
JVB 2022-05-02 11:40:14.891 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:40:14.891 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=4jml71g22mrqdo gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:40:14.892 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo epId=168c643f local_ufrag=4jml71g22mrqdo] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:40:14.892 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo epId=168c643f local_ufrag=4jml71g22mrqdo] Agent.initCheckLists#969: Init checklist for stream stream-168c643f
JVB 2022-05-02 11:40:14.892 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo epId=168c643f local_ufrag=4jml71g22mrqdo] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:40:14.892 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=4jml71g22mrqdo gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:40:14.892 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo epId=168c643f local_ufrag=4jml71g22mrqdo] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:40:15.043 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo name=stream-168c643f epId=168c643f local_ufrag=4jml71g22mrqdo] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-168c643f.RTP: 10.100.10.196:51690/udp
JVB 2022-05-02 11:40:15.044 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo name=stream-168c643f epId=168c643f local_ufrag=4jml71g22mrqdo] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 10.100.10.196:51690/udp/host (stream-168c643f.RTP).
JVB 2022-05-02 11:40:15.057 WARNING: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo epId=168c643f local_ufrag=4jml71g22mrqdo] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0x50EB6D858001A0ACCC5F39D6]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->10.100.10.196:51690/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:40:15.057 INFO: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo epId=168c643f local_ufrag=4jml71g22mrqdo] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 10.100.10.196:51690/udp/host (stream-168c643f.RTP)
JVB 2022-05-02 11:40:16.119 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] AbstractEndpoint.expire#316: Expiring.
JVB 2022-05-02 11:40:16.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1070: Spent 0 seconds oversending
JVB 2022-05-02 11:40:16.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Transceiver.teardown#348: Tearing down
JVB 2022-05-02 11:40:16.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] RtpReceiverImpl.tearDown#344: Tearing down
JVB 2022-05-02 11:40:16.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] RtpSenderImpl.tearDown#314: Tearing down
JVB 2022-05-02 11:40:16.121 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.stop#186: Stopping
JVB 2022-05-02 11:40:16.121 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=fhn881g22mrakc gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.stop#251: Stopping
JVB 2022-05-02 11:40:16.121 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc epId=f5f2a84f local_ufrag=fhn881g22mrakc] Agent.setState#943: ICE state changed from Running to Terminated.
JVB 2022-05-02 11:40:16.122 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=fhn881g22mrakc name=stream-f5f2a84f epId=f5f2a84f local_ufrag=fhn881g22mrakc] MergingDatagramSocket.close#142: Closing.
JVB 2022-05-02 11:40:16.122 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1088: Expired.
JVB 2022-05-02 11:40:16.126 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=dravn1g22mrrrt gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt] Agent.gatherCandidates#644: Gathering candidates for component stream-f5f2a84f.RTP.
JVB 2022-05-02 11:40:16.130 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.<init>#293: Created new endpoint isUsingSourceNames=false, iceControlling=true
JVB 2022-05-02 11:40:16.287 INFO: [22] HealthChecker.run#171: Performed a successful health check in PT0.00001S. Sticky failure: false
JVB 2022-05-02 11:40:16.568 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:40:16.568 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=dravn1g22mrrrt gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:40:16.568 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt epId=f5f2a84f local_ufrag=dravn1g22mrrrt] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:40:16.568 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt epId=f5f2a84f local_ufrag=dravn1g22mrrrt] Agent.initCheckLists#969: Init checklist for stream stream-f5f2a84f
JVB 2022-05-02 11:40:16.568 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt epId=f5f2a84f local_ufrag=dravn1g22mrrrt] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:40:16.568 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=dravn1g22mrrrt gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:40:16.568 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt epId=f5f2a84f local_ufrag=dravn1g22mrrrt] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:40:16.714 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt name=stream-f5f2a84f epId=f5f2a84f local_ufrag=dravn1g22mrrrt] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-f5f2a84f.RTP: 192.168.1.65:60481/udp
JVB 2022-05-02 11:40:16.714 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt name=stream-f5f2a84f epId=f5f2a84f local_ufrag=dravn1g22mrrrt] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 192.168.1.65:60481/udp/host (stream-f5f2a84f.RTP).
JVB 2022-05-02 11:40:16.732 WARNING: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt epId=f5f2a84f local_ufrag=dravn1g22mrrrt] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0xDBF16D8580017BA4B3376551]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->192.168.1.65:60481/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:40:16.732 INFO: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt epId=f5f2a84f local_ufrag=dravn1g22mrrrt] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 192.168.1.65:60481/udp/host (stream-f5f2a84f.RTP)
JVB 2022-05-02 11:40:26.286 INFO: [22] HealthChecker.run#171: Performed a successful health check in PT0.00001S. Sticky failure: false
JVB 2022-05-02 11:40:32.119 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] AbstractEndpoint.expire#316: Expiring.
JVB 2022-05-02 11:40:32.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1070: Spent 0 seconds oversending
JVB 2022-05-02 11:40:32.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Transceiver.teardown#348: Tearing down
JVB 2022-05-02 11:40:32.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpReceiverImpl.tearDown#344: Tearing down
JVB 2022-05-02 11:40:32.120 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpSenderImpl.tearDown#314: Tearing down
JVB 2022-05-02 11:40:32.121 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.stop#186: Stopping
JVB 2022-05-02 11:40:32.121 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=4jml71g22mrqdo gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.stop#251: Stopping
JVB 2022-05-02 11:40:32.121 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo epId=168c643f local_ufrag=4jml71g22mrqdo] Agent.setState#943: ICE state changed from Running to Terminated.
JVB 2022-05-02 11:40:32.122 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=4jml71g22mrqdo name=stream-168c643f epId=168c643f local_ufrag=4jml71g22mrqdo] MergingDatagramSocket.close#142: Closing.
JVB 2022-05-02 11:40:32.122 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1088: Expired.
JVB 2022-05-02 11:40:32.124 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=ddvhk1g22msbfr gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr] Agent.gatherCandidates#644: Gathering candidates for component stream-168c643f.RTP.
JVB 2022-05-02 11:40:32.130 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.<init>#293: Created new endpoint isUsingSourceNames=false, iceControlling=true
JVB 2022-05-02 11:40:32.361 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:40:32.362 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=ddvhk1g22msbfr gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:40:32.362 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr epId=168c643f local_ufrag=ddvhk1g22msbfr] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:40:32.362 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr epId=168c643f local_ufrag=ddvhk1g22msbfr] Agent.initCheckLists#969: Init checklist for stream stream-168c643f
JVB 2022-05-02 11:40:32.362 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr epId=168c643f local_ufrag=ddvhk1g22msbfr] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:40:32.362 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=ddvhk1g22msbfr gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:40:32.362 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr epId=168c643f local_ufrag=ddvhk1g22msbfr] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:40:32.516 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr name=stream-168c643f epId=168c643f local_ufrag=ddvhk1g22msbfr] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-168c643f.RTP: 10.100.10.196:63692/udp
JVB 2022-05-02 11:40:32.516 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr name=stream-168c643f epId=168c643f local_ufrag=ddvhk1g22msbfr] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 10.100.10.196:63692/udp/host (stream-168c643f.RTP).
JVB 2022-05-02 11:40:32.527 WARNING: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr epId=168c643f local_ufrag=ddvhk1g22msbfr] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0x8E2F6E858001D7FEB3422085]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->10.100.10.196:63692/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:40:32.527 INFO: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr epId=168c643f local_ufrag=ddvhk1g22msbfr] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 10.100.10.196:63692/udp/host (stream-168c643f.RTP)
JVB 2022-05-02 11:40:33.823 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] AbstractEndpoint.expire#316: Expiring.
JVB 2022-05-02 11:40:33.823 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1070: Spent 0 seconds oversending
JVB 2022-05-02 11:40:33.824 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Transceiver.teardown#348: Tearing down
JVB 2022-05-02 11:40:33.824 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] RtpReceiverImpl.tearDown#344: Tearing down
JVB 2022-05-02 11:40:33.824 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] RtpSenderImpl.tearDown#314: Tearing down
JVB 2022-05-02 11:40:33.824 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.stop#186: Stopping
JVB 2022-05-02 11:40:33.825 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=dravn1g22mrrrt gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.stop#251: Stopping
JVB 2022-05-02 11:40:33.825 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt epId=f5f2a84f local_ufrag=dravn1g22mrrrt] Agent.setState#943: ICE state changed from Running to Terminated.
JVB 2022-05-02 11:40:33.825 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=dravn1g22mrrrt name=stream-f5f2a84f epId=f5f2a84f local_ufrag=dravn1g22mrrrt] MergingDatagramSocket.close#142: Closing.
JVB 2022-05-02 11:40:33.826 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1088: Expired.
JVB 2022-05-02 11:40:33.829 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=5smk1g22msd55 gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55] Agent.gatherCandidates#644: Gathering candidates for component stream-f5f2a84f.RTP.
JVB 2022-05-02 11:40:33.833 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.<init>#293: Created new endpoint isUsingSourceNames=false, iceControlling=true
JVB 2022-05-02 11:40:34.283 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.setSetupAttribute#120: The remote side is acting as DTLS client, we'll act as server
JVB 2022-05-02 11:40:34.283 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=5smk1g22msd55 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.startConnectivityEstablishment#198: Starting the Agent without remote candidates.
JVB 2022-05-02 11:40:34.283 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 epId=f5f2a84f local_ufrag=5smk1g22msd55] Agent.startConnectivityEstablishment#733: Start ICE connectivity establishment.
JVB 2022-05-02 11:40:34.284 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 epId=f5f2a84f local_ufrag=5smk1g22msd55] Agent.initCheckLists#969: Init checklist for stream stream-f5f2a84f
JVB 2022-05-02 11:40:34.284 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 epId=f5f2a84f local_ufrag=5smk1g22msd55] Agent.setState#943: ICE state changed from Waiting to Running.
JVB 2022-05-02 11:40:34.284 INFO: [54] [confId=24ad4a73a5bb2db2 epId=f5f2a84f local_ufrag=5smk1g22msd55 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.iceStateChanged#341: ICE state changed old=Waiting new=Running
JVB 2022-05-02 11:40:34.284 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 epId=f5f2a84f local_ufrag=5smk1g22msd55] ConnectivityCheckClient.startChecks#149: Start connectivity checks.
JVB 2022-05-02 11:40:34.419 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 name=stream-f5f2a84f epId=f5f2a84f local_ufrag=5smk1g22msd55] Component.addUpdateRemoteCandidates#347: Update remote candidate for stream-f5f2a84f.RTP: 192.168.1.65:49942/udp
JVB 2022-05-02 11:40:34.420 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 name=stream-f5f2a84f epId=f5f2a84f local_ufrag=5smk1g22msd55] Component.updateRemoteCandidates#484: new Pair added: 67.225.224.214:10000/udp/host -> 192.168.1.65:49942/udp/host (stream-f5f2a84f.RTP).
JVB 2022-05-02 11:40:34.425 WARNING: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 epId=f5f2a84f local_ufrag=5smk1g22msd55] ConnectivityCheckClient.startCheckForPair#374: Failed to send BINDING-REQUEST(0x1)[attrib.count=6 len=92 tranID=0xF9366E8580012B561CDB833C]
java.lang.IllegalArgumentException: No socket found for 67.225.224.214:10000/udp->192.168.1.65:49942/udp
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:631)
	at org.ice4j.stack.NetAccessManager.sendMessage(NetAccessManager.java:581)
	at org.ice4j.stack.StunClientTransaction.sendRequest0(StunClientTransaction.java:267)
	at org.ice4j.stack.StunClientTransaction.sendRequest(StunClientTransaction.java:245)
	at org.ice4j.stack.StunStack.sendRequest(StunStack.java:680)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:335)
	at org.ice4j.ice.ConnectivityCheckClient.startCheckForPair(ConnectivityCheckClient.java:231)
	at org.ice4j.ice.ConnectivityCheckClient$PaceMaker.run(ConnectivityCheckClient.java:938)
	at org.ice4j.util.PeriodicRunnable.executeRun(PeriodicRunnable.java:206)
	at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Executors.java:515)
	at java.base/java.util.concurrent.FutureTask.run(FutureTask.java:264)
	at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1128)
	at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:628)
	at java.base/java.lang.Thread.run(Thread.java:829)
JVB 2022-05-02 11:40:34.426 INFO: [63] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Tremayne-5wm conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=5smk1g22msd55 epId=f5f2a84f local_ufrag=5smk1g22msd55] ConnectivityCheckClient$PaceMaker.run#942: Pair failed: 67.225.224.214:10000/udp/host -> 192.168.1.65:49942/udp/host (stream-f5f2a84f.RTP)
JVB 2022-05-02 11:40:36.286 INFO: [22] HealthChecker.run#171: Performed a successful health check in PT0.00001S. Sticky failure: false
JVB 2022-05-02 11:40:46.286 INFO: [22] HealthChecker.run#171: Performed a successful health check in PT0.00001S. Sticky failure: false
JVB 2022-05-02 11:40:46.341 INFO: [27] VideobridgeExpireThread.expire#140: Running expire()
JVB 2022-05-02 11:40:49.594 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] AbstractEndpoint.expire#316: Expiring.
JVB 2022-05-02 11:40:49.595 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1070: Spent 0 seconds oversending
JVB 2022-05-02 11:40:49.595 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Transceiver.teardown#348: Tearing down
JVB 2022-05-02 11:40:49.595 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpReceiverImpl.tearDown#344: Tearing down
JVB 2022-05-02 11:40:49.595 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] RtpSenderImpl.tearDown#314: Tearing down
JVB 2022-05-02 11:40:49.596 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] DtlsTransport.stop#186: Stopping
JVB 2022-05-02 11:40:49.596 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f local_ufrag=ddvhk1g22msbfr gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] IceTransport.stop#251: Stopping
JVB 2022-05-02 11:40:49.596 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr epId=168c643f local_ufrag=ddvhk1g22msbfr] Agent.setState#943: ICE state changed from Running to Terminated.
JVB 2022-05-02 11:40:49.597 INFO: [54] [confId=24ad4a73a5bb2db2 gid=-2 stats_id=Marisa-mnd componentId=1 conf_name=gonefishing@conference.dreaming.hashtag.space ufrag=ddvhk1g22msbfr name=stream-168c643f epId=168c643f local_ufrag=ddvhk1g22msbfr] MergingDatagramSocket.close#142: Closing.
JVB 2022-05-02 11:40:49.597 INFO: [54] [confId=24ad4a73a5bb2db2 epId=168c643f gid=-2 stats_id=Marisa-mnd conf_name=gonefishing@conference.dreaming.hashtag.space] Endpoint.expire#1088: Expired.

The installation is here and is open for the time being. dreaming.hashtag.space

Any help would be greatly appreciated.

damencho · May 2, 2022, 8:10pm

Check your firewall rules, maybe UDP or port 10000 is blocked in the other direction from jvb to the clients.

adminblackwood · May 2, 2022, 8:18pm

We are running ufw.

[root@dreaming ~]# ufw status
Status: active

To                         Action      From
--                         ------      ----
80/tcp                     ALLOW       Anywhere
443/tcp                    ALLOW       Anywhere
10000/udp                  ALLOW       Anywhere
22/tcp                     ALLOW       Anywhere
3478/udp                   ALLOW       Anywhere
5349/tcp                   ALLOW       Anywhere
80/tcp (v6)                ALLOW       Anywhere (v6)
443/tcp (v6)               ALLOW       Anywhere (v6)
10000/udp (v6)             ALLOW       Anywhere (v6)
22/tcp (v6)                ALLOW       Anywhere (v6)
3478/udp (v6)              ALLOW       Anywhere (v6)
5349/tcp (v6)              ALLOW       Anywhere (v6)

adminblackwood · May 2, 2022, 8:19pm

I have also tried disabling ufw and we get the same results.

Freddie · May 2, 2022, 8:40pm

@adminblackwood Are you behind a NAT? Also, check for websocket errors.

damencho · May 2, 2022, 9:17pm

If you open chrome://webrtc-internals/ then open 3 tabs, you will see the peer connections and how requests are sent (ice candidate pairs) and nothing in reply, so either those are not received on the bridge side or the replies are not sent to the clients.
And in the js console, you can see ice failed for the jvb peer connection.

adminblackwood · May 2, 2022, 9:32pm

Thank you for that information. Any idea what could be the cause?

damencho · May 2, 2022, 9:40pm

Everything points to network issue.

gpatel-fr · May 3, 2022, 8:00am

this is a hoster IP address, while you are talking about ‘home network’. Do you mean that the ‘home network’ is accessing the server through a VPN ? that would maybe explain why JVB is trying to connect to 2 different private IP addresses.

adminblackwood · May 3, 2022, 12:15pm

Yes, that is the host server ip address. When connecting from my home network everything works perfectly. It is when someone in another location joins that the audio and video stops working. None of the parties joining the meeting are using a VPN.

adminblackwood · May 23, 2022, 4:01pm

This was indeed a network issue. After a couple of days of back and forth with support at a premium hosting provider we canceled that server and leased a bare metal version of the same server at half the price from a discount source. I had the basic jitsi service up and working perfectly in less than an hour with the help of the discount support team. We did run into trouble adding JWT authentication, but with the help of the search function here in the community this too is working perfectly now. Also just added the prosody plugin to destroy the room when the mod leaves which is working great as well. Love the software and the help provided here!