Oscam + TVHeadend + Unraid + Docker = Random "Unknown socket command received"

[n4pl]

Hallo zusammen,

zu aller erst, diese Konfiguration läuft seit Jahren und nun seit ~September nur noch fehlerhaft. Mein Aufbau ist wie folgt:

Alt:

• Unraid-Server
  • TVHeadend (4.3-1983~gb8710206e - Docker)
  • Oscam (r11703 - Docker): Webif 8888 - dvbapi 10000
• easymouse2 an dem Unraid-Server
• HD01-Karte
• EPG werden jeden Tag durch easyEPG und Import geupdatet (aber erst um 20:30 Uhr)

Neu (seit September):

• Wir sind umgezogen und ich habe die Hardware in ein anderes Gehäuse gebaut
• FritzBox wurde durch eine UDM Pro ersetzt

Vor lauter Verzweiflung habe ich oscam mittlerweile neu eingerichtet, aber es ergibt sich dennoch die Situation das völlig willkürlich (teilweise merkt man es kaum da es erst nach dem Umschalten passiert) plötzlich tvheadend meldet:

TVHeadend:

"subscription: 0001: service instance is bad, reason: No descrambler"

Spoiler: Oscam-Log:

2021/11/25 00:22:02 36240564 c (dvbapi) Demuxer 0 stopped descrambling for program EF74 (1830@000000:EF74 unknown)
2021/11/25 15:45:57 36240564 c (dvbapi) Client connected: 'Tvheadend 4.3-1983~gb8710206e' (protocol version = 2)
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x47455420
2021/11/25 18:05:27 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x4554202F
2021/11/25 18:05:27 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x54202F20
2021/11/25 18:05:27 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x202F2048
2021/11/25 18:05:27 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x2F204854
2021/11/25 18:05:27 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x20485454
2021/11/25 18:05:27 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x48545450
2021/11/25 18:05:27 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:05:27 36240564 c (dvbapi) Unknown socket command received: 0x5454502F
...
2021/11/25 18:07:36 6527D880 h (webif) WebIf: No data received from client 192.168.2.1. Closing connection.
...
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x24000000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 7 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000001
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000100
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00010000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x01000000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000001
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000100
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00010000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x01000000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000006
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000600
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00060000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x06000000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000061
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00006162
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00616263
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x61626364
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x62636465
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x63646566
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x64656600
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x65660000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x66000004
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000400
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00040000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x04000000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000067
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00006765
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00676574
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x67657400
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x65740000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x74000000
2021/11/25 18:07:47 36240564 c (-) -- Skipped 1 duplicated log lines --
2021/11/25 18:07:47 36240564 c (dvbapi) Unknown socket command received: 0x00000000
2021/11/25 19:32:03 36240564 c (-) -- Skipped 3 duplicated log lines --
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 0 CAID: 4AF4 ECM_PID: 0209 PROVID: 000001
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 1 CAID: 1842 ECM_PID: 1FD0 PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 2 CAID: 4B64 ECM_PID: 1FD0 PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 3 CAID: 098D ECM_PID: 0208 PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 4 CAID: 186D ECM_PID: 1FCF PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 5 CAID: 186A ECM_PID: 1FCE PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 6 CAID: 09C4 ECM_PID: 1BCE PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 7 CAID: 098C ECM_PID: 1ACE PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 8 CAID: 1860 ECM_PID: 1ECE PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 9 CAID: 1843 ECM_PID: 19CE PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 ecmpid 10 CAID: 1830 ECM_PID: 1CCE PROVID: 000000
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 found 11 ECM pids and 4 STREAM pids in CA PMT
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 found channel in cache and matching prio -> start descrambling ecmpid 10
2021/11/25 19:32:03 36240564 c (dvbapi) Demuxer 0 trying to descramble PID 10 CAID 1830 PROVID 000000 ECMPID 1CCE ANY CHID PMTPID 0061 VPID 01FF
2021/11/25 19:32:05 36240564 c (dvbapi) Demuxer 0 stopped descrambling for program EF11 (4AF4@000001:EF11 unknown)
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 0 CAID: 4AF4 ECM_PID: 0209 PROVID: 000001
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 1 CAID: 1842 ECM_PID: 1FD0 PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 2 CAID: 4B64 ECM_PID: 1FD0 PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 3 CAID: 098D ECM_PID: 0208 PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 4 CAID: 186D ECM_PID: 1FCF PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 5 CAID: 186A ECM_PID: 1FCE PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 6 CAID: 09C4 ECM_PID: 1BCE PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 7 CAID: 098C ECM_PID: 1ACE PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 8 CAID: 1860 ECM_PID: 1ECE PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 9 CAID: 1843 ECM_PID: 19CE PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 ecmpid 10 CAID: 1830 ECM_PID: 1CCE PROVID: 000000
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 found 11 ECM pids and 4 STREAM pids in CA PMT
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 found channel in cache and matching prio -> start descrambling ecmpid 10
2021/11/25 19:32:06 36240564 c (dvbapi) Demuxer 0 trying to descramble PID 10 CAID 1830 PROVID 000000 ECMPID 1CCE ANY CHID PMTPID 0061 VPID 01FF
2021/11/25 19:32:07 36240564 c (dvbapi) Demuxer 0 stopped descrambling for program EF11 (4AF4@000001:EF11 unknown)

Spoiler: TVHeadend Docker-Log

2021-11-25 15:45:57.060 [ INFO] main: Log started
2021-11-25 15:45:57.061 [ INFO] http: Starting HTTP server 0.0.0.0:9981
2021-11-25 15:45:57.061 [ INFO] htsp: Starting HTSP server 0.0.0.0:9982
2021-11-25 15:45:57.085 [ INFO] config: loaded
2021-11-25 15:45:57.085 [ INFO] config: scanfile (re)initialization with path <none>
2021-11-25 15:45:57.085 [ INFO] transcode: 'video' context type registered
2021-11-25 15:45:57.085 [ INFO] transcode: 'audio' context type registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHH264Decoder' decoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHTHEORADecoder' decoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHAACDecoder' decoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHVORBISDecoder' decoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHOPUSDecoder' decoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHMPEG2VIDEOEncoder' encoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHH264Encoder' encoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHHEVCEncoder' encoder helper registered
2021-11-25 15:45:57.085 [ INFO] transcode: '&TVHAACEncoder' encoder helper registered
2021-11-25 15:45:57.088 [ INFO] codec: 'mpeg2video' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'mp2' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'aac' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'vorbis' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'flac' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'libx264' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'libx265' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'libvpx' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'libvpx-vp9' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'libtheora' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'libvorbis' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'libopus' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'h264_vaapi' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'hevc_vaapi' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'vp8_vaapi' encoder registered
2021-11-25 15:45:57.088 [ INFO] codec: 'vp9_vaapi' encoder registered
2021-11-25 15:45:57.090 [ INFO] codec: 'webtv-aac' codec profile created
2021-11-25 15:45:57.090 [ INFO] codec: 'webtv-vorbis' codec profile created
2021-11-25 15:45:57.090 [ INFO] codec: 'webtv-vp8' codec profile created
2021-11-25 15:45:57.090 [ INFO] codec: 'webtv-h264' codec profile created
2021-11-25 15:45:57.090 [ ERROR] codec: codec profile 'webtv-vorbis' already exists
2021-11-25 15:45:57.090 [ ERROR] codec: unable to load codec profile: 'webtv-vorbis'
2021-11-25 15:45:57.090 [ INFO] codec: 'hevc-vaapi' codec profile created
2021-11-25 15:45:57.090 [ INFO] codec: 'h264-vaapi' codec profile created
2021-11-25 15:45:57.090 [ ERROR] codec: codec profile 'webtv-vp8' already exists
2021-11-25 15:45:57.090 [ ERROR] codec: unable to load codec profile: 'webtv-vp8'
2021-11-25 15:45:57.090 [ ERROR] codec: codec profile 'webtv-aac' already exists
2021-11-25 15:45:57.090 [ ERROR] codec: unable to load codec profile: 'webtv-aac'
2021-11-25 15:45:57.090 [ INFO] codec: 'h264-test' codec profile created
2021-11-25 15:45:57.090 [ ERROR] codec: codec profile 'webtv-h264' already exists
2021-11-25 15:45:57.090 [ ERROR] codec: unable to load codec profile: 'webtv-h264'
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S2,23.5E,12187000,H,27500000,921', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,19.2E,12515000,H,22000000,921', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,19.2E,12515000,H,22000000,900', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,23.5E,12070000,H,27500000,30', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,19.2E,12515000,H,22000000,920', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,23.5E,12070000,H,27500000,911', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,19.2E,12515000,H,22000000,950', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,23.5E,12070000,H,27500000,31', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,23.5E,12070000,H,27500000,901', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S2,23.5E,12187000,H,27500000,950', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,19.2E,12515000,H,22000000,911', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,19.2E,12515000,H,22000000,910', remove duplicate config
2021-11-25 15:45:57.116 [ ERROR] bouquet: found duplicate source id: 'dvb-fastscan://DVB-S,19.2E,12515000,H,22000000,901', remove duplicate config
2021-11-25 15:45:57.117 [ INFO] capmt: dvbapi active
2021-11-25 15:45:57.117 [ INFO] descrambler: adding CAID 2600/FFFF as ConstCW interval 10000ms pc 20 ep default (BISS)
2021-11-25 15:45:57.117 [ INFO] descrambler: adding CAID 0E00/FFFF as MultiPID interval 1000ms pc 2 ep default (PowerVu)
2021-11-25 15:45:57.117 [ INFO] capmt: dvbapi: mode 5 connected to 192.168.2.2:10000 (single)
2021-11-25 15:45:57.117 [ INFO] capmt: dvbapi: Connected to server 'OSCam v1.20_svn, build r11703 (x86_64-alpine-linux-musl); ' (protocol version 3)
2021-11-25 15:45:57.246 [ INFO] iptv: Using 2 input thread(s)
2021-11-25 15:45:57.272 [ INFO] linuxdvb: adapter added /dev/dvb/adapter1
2021-11-25 15:45:57.302 [ INFO] linuxdvb: adapter added /dev/dvb/adapter0
2021-11-25 15:45:57.363 [ INFO] dvr: Creating new configuration ''
2021-11-25 15:45:57.363 [ INFO] dvr: Creating new configuration ''
2021-11-25 15:45:57.363 [ ERROR] dvr: Unable to create second default config, removing
2021-11-25 15:45:57.366 [ INFO] epggrab: module uk_freesat created
2021-11-25 15:45:57.366 [ INFO] epggrab: module uk_freesat_eit created
2021-11-25 15:45:57.366 [ INFO] epggrab: module uk_freeview created
2021-11-25 15:45:57.366 [ INFO] epggrab: module nz_freeview2 created
2021-11-25 15:45:57.366 [ INFO] epggrab: module nz_freeview1 created
2021-11-25 15:45:57.366 [ INFO] epggrab: module viasat_baltic created
2021-11-25 15:45:57.366 [ INFO] epggrab: module Bulsatcom_39E created
2021-11-25 15:45:57.366 [ INFO] epggrab: module uk_cable_virgin created
2021-11-25 15:45:57.366 [ INFO] epggrab: module eit created
2021-11-25 15:45:57.366 [ INFO] epggrab: module psip created
2021-11-25 15:45:57.370 [ INFO] epggrab: module opentv-ausat created
2021-11-25 15:45:57.370 [ INFO] epggrab: module opentv-skyit created
2021-11-25 15:45:57.370 [ INFO] epggrab: module opentv-skynz created
2021-11-25 15:45:57.370 [ INFO] epggrab: module opentv-skyuk created
2021-11-25 15:45:57.370 [ INFO] epggrab: module xmltv created
2021-11-25 15:45:57.371 [ INFO] spawn: Executing "/usr/bin/tv_find_grabbers"
2021-11-25 15:45:57.555 [ INFO] scanfile: DVB-S - loaded 1 regions with 115 networks
2021-11-25 15:45:57.555 [ INFO] scanfile: DVB-T - loaded 44 regions with 1124 networks
2021-11-25 15:45:57.555 [ INFO] scanfile: DVB-C - loaded 19 regions with 64 networks
2021-11-25 15:45:57.555 [ INFO] scanfile: ATSC-T - loaded 2 regions with 12 networks
2021-11-25 15:45:57.555 [ INFO] scanfile: ATSC-C - loaded 1 regions with 5 networks
2021-11-25 15:45:57.555 [ INFO] scanfile: ISDB-T - loaded 2 regions with 1297 networks
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_ar created
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_combiner created
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_dk_dr created
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_eu_epgdata created
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_eu_xmltvse created
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_fi created
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_fi_sv created
2021-11-25 15:45:58.550 [ INFO] epggrab: module /usr/bin/tv_grab_fr created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_huro created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_is created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_it created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_na_dd created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_na_dtv created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_na_tvmedia created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_tr created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_uk_bleb created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_uk_tvguide created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_zz_sdjson created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_zz_sdjson_sqlite created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_file created
2021-11-25 15:45:58.551 [ INFO] epggrab: module /usr/bin/tv_grab_wg created
2021-11-25 15:45:58.576 [WARNING] epggrab: ota cron config invalid or unset
2021-11-25 15:45:58.576 [ INFO] xmltv: xmltv: external socket enabled
2021-11-25 15:45:58.700 [WARNING] epggrab: ota cron config invalid or unset
2021-11-25 15:45:58.701 [ INFO] epgdb: gzip format detected, inflating (ratio 24.2% deflated size 1762898)
2021-11-25 15:45:58.722 [ INFO] epgdb: parsing 7298730 bytes
2021-11-25 15:45:58.802 [ INFO] epgdb: loaded v3
2021-11-25 15:45:58.802 [ INFO] epgdb: config 1
2021-11-25 15:45:58.802 [ INFO] epgdb: broadcasts 9465
2021-11-25 15:45:58.807 [ INFO] dvr: Purging obsolete autorec entries for current schedule
2021-11-25 15:45:58.810 [ NOTICE] START: HTS Tvheadend version 4.3-1983~gb8710206e started, running as PID:351 UID:1000 GID:100, CWD:/run/s6/services/tvheadend CNF:/config
2021-11-25 17:45:57.000 [ INFO] epgdb: snapshot start
2021-11-25 17:45:57.040 [ INFO] epgdb: queued to save (size 6663343)
2021-11-25 17:45:57.040 [ INFO] epgdb: broadcasts 9369
2021-11-25 17:45:57.040 [ INFO] epgdb: save start
2021-11-25 17:45:57.124 [ INFO] epgdb: stored (size 1608969)
2021-11-25 19:32:03.061 [ INFO] htsp: Got connection from 192.168.2.3
2021-11-25 19:32:03.074 [ INFO] htsp: 192.168.2.3: Welcomed client software: Kodi Media Center (HTSPv34)
2021-11-25 19:32:03.074 [ INFO] htsp: 192.168.2.3 [ Kodi Media Center ]: Identified as user 'n4pl'
2021-11-25 19:32:03.074 [ INFO] htsp: 192.168.2.3 [ n4pl | Kodi Media Center ]: Privileges updated
2021-11-25 19:32:03.501 [ INFO] mpegts: 10832.25H in Cine S2 V6 - tuning on STV090x Multistandard #1 : DVB-S #0
2021-11-25 19:32:03.782 [ INFO] capmt: dvbapi: Starting CAPMT server for service "VOX HD" on adapter 1
2021-11-25 19:32:03.782 [ INFO] subscription: 0001: "192.168.2.3 [ n4pl | Kodi Media Center ]" subscribing on channel "VOX", weight: 150, adapter: "STV090x Multistandard #1 : DVB-S #0", network: "Cine S2 V6", mux: "10832.25H", provider: "CBC", service: "VOX HD", profile="htsp", hostname="192.168.2.3", username="n4pl", client="Kodi Media Center"
2021-11-25 19:32:05.718 [WARNING] subscription: 0001: service instance is bad, reason: No descrambler

Das interessante ist das ein restart von Oscam ODER Tvheadend reicht damit die Verbindung wieder da ist.

Jedoch der Flood mit dem unkown socket scheint das Problem zu sein, denn das findet sich immer wenn das Problem auftritt.

Spoiler: oscam.conf

[global]
logfile = /config/log/oscam.log
initial_debuglevel = 8
disableuserfile = 0
disablemail = 0
maxlogsize = 10000
usrfile = /config/log/oscamuser.log

[cache]

[dvbapi]
enabled = 1
au = 1
pmt_mode = 4
listen_port = 10000
user = dvbapi
boxtype = pc

[webif]
httpport = 8888
httpuser = admin
httppwd = xxxxx
httpallowed = 127.0.0.1,192.168.0.0-192.168.255.255,10.0.0.0-10.255.255.255,255.255.255.255

Spoiler: oscam.user

[account]
user = dvbapi
group = 1
au = 1
services = hdplus

Spoiler: oscam.server

[reader]
label = HDPLUS
description = HD+Reader
protocol = mouse
device = /dev/ttyUSB0
services = hdplus
keepalive = 1
caid = 1830
boxkey = A7642F57BC96D37C
rsakey = BF358B5461863130686FC933FB541FFCED682F3680F09DBC1A23829FB3B2F766B9DD1BF3B3ECC9AD6661B753DCC3A9624156F9EB64E8168EF09E4D9C5CCA4DD5
detect = cd
mhz = 600
cardmhz = 368
group = 1
emmcache = 1,3,2,0
inactivitytimeout = -1
connectoninit = 1

Spoiler

Du musst Regestriert sein, um das angehängte Bild zusehen.

Ich hoffe das ich nichts vergessen habe, wenn doch reiche ich es gern nach. Aber ich Google nun seit Wochen es hoch und runter und komme zu keiner Lösung. Ich habe jegliche Auto-Updates der Docker-Container (welche vorher immer aktiv waren) deaktiviert da ich in einem anderen Thread (

Sie müssen registriert sein, um Links zu sehen.

) genau mein Problem auch gefunden hatte, allerdings anderer Aufbau mit OMV. Ich bin mittlerweile ratlos, habe wirklich alle logs durchgesehen.

Vielen dank

cheers

 

[2predator]

Hi versuch mal
oscam.dvbapi
I: 4AF4

vg

 

[Kind regards]

Spoiler: hier funktioniert es so

Du musst Regestriert sein, um das angehängte Bild zusehen.

Du musst Regestriert sein, um das angehängte Bild zusehen.

 

[renedis]

Sorry for English, but i have the exact same issue:
I get the "unknown socket command received" message and can keep watching the same channel, but if I change it stops working:

Spoiler: Code

2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x00040000
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x04000000
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x00000067
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x00006765
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x00676574
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x67657400
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x65740000
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x74000000
2021/12/28 16:34:35 295CBF49 c (-) -- Skipped 1 duplicated log lines --
2021/12/28 16:34:35 295CBF49 c (dvbapi) Unknown socket command received: 0x00000000
2021/12/28 16:34:36 295CBF49 c (-) -- Skipped 3 duplicated log lines --

 

[n4pl]

Hey renedis,

do u have aso a UDM Pro? In my special situation it was the "Threat Scanner"... if u are on the latest network release u can only disable it in the iOS App (at Android the "Security"-Point is missing!) not in the WebGui.

 

[renedis]

Yes, I do have a UDM Pro with Honeypot enabled. I saw your comment in the other thread, thank you for that!
But, I've just disabled it and it happened again. Do I need to reboot the UDM Pro to make sure?

@n4pl Just to make sure; it's this disabled "Internal Honeypot" setting right?

 

[n4pl]

No u need to disable the "Threat Scanner"... its Enabled on your screenshot

 

[renedis]

Just happened again. I've now disabled the "Threat Scanner" and will report back if it was the solution. Thank you again!

@n4pl off topic: Check out the custom mods for the UDM-Pro:

Sie müssen registriert sein, um Links zu sehen.

And my own custom mods for UDM-Pro (oscam and TVHeadend on the UDM):

Sie müssen registriert sein, um Links zu sehen.

Sie müssen registriert sein, um Links zu sehen.

 

[n4pl]

it was the solution for sure... that "threat scanner" is bullshit... your log looks like mine before disabling it

 

[renedis]

@n4pl I can't thank you enough! No more Oscam "Unknown socket command" since i've turned it off!

 

[n4pl]

you're welcome