Aug 26 08:11:15 localhost vdr: [1148] channel 130 (Sky Cinema Action) event Sa. 26.08.2017 08:15-09:45 'Autobahnraser' status 4 Aug 26 08:11:17 localhost vdr: [1148] changing pids of channel 130 (Sky Cinema Action) from 767+767=27:768=deu@3,769=eng@3;771=deu@106:0:0 to 767+767=27:768=deu@3;771=deu@106:0:0 Aug 26 08:11:18 localhost vdr: [1201] VNSI: Requesting clients to reload channel list Aug 26 08:11:18 localhost vdr: [1085] stopping recording due to modification of channel 130 (Sky Cinema Action) Aug 26 08:11:18 localhost vdr: [9984] recording thread ended (pid=1085, tid=9984) Aug 26 08:11:18 localhost vdr: [1085] CAM 1: unassigned from device 2 Aug 26 08:11:18 localhost vdr: [1162] DDCI-Err (ddcitsrecv.cpp,151): skipped 157 bytes to sync on start of TS packet Aug 26 08:11:18 localhost vdr: [1085] buffer stats: 186308 (0%) used Aug 26 08:11:18 localhost vdr: [1085] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') stop Aug 26 08:11:18 localhost vdr: [1085] executing '/usr/lib/vdr/vdr-recordingaction after "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:11:18 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom after recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:11:18 localhost vdr: [9965] device 2 TS buffer thread ended (pid=1085, tid=9965) Aug 26 08:11:18 localhost vdr: [9963] buffer stats: 95880 (1%) used Aug 26 08:11:18 localhost vdr: [9963] device 2 receiver thread ended (pid=1085, tid=9963) Aug 26 08:11:19 localhost vdr: [1085] CAM 1/1: reusing MTD CAM slot Aug 26 08:11:19 localhost vdr: [1085] CAM 1: assigned to device 2 Aug 26 08:11:19 localhost vdr: [1085] switching device 2 to channel 130 S19.2E-133-3-9 (Sky Cinema Action) Aug 26 08:11:19 localhost vdr: [10743] device 2 receiver thread started (pid=1085, tid=10743, prio=high) Aug 26 08:11:19 localhost vdr: [10744] device 2 TS buffer thread started (pid=1085, tid=10744, prio=high) Aug 26 08:11:19 localhost vdr: [1085] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') start Aug 26 08:11:19 localhost vdr: [1085] Title: 'Batman v Superman: Dawn of Justice' Subtitle: 'Actionfilm' Aug 26 08:11:19 localhost vdr: [1085] executing '/usr/lib/vdr/vdr-recordingaction before "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:11:19 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom before recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:11:19 localhost vdr: [1085] record /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:11:19 localhost vdr: [1085] recording to '/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec/00002.ts' Aug 26 08:11:19 localhost vdr: [10765] recording thread started (pid=1085, tid=10765, prio=high) Aug 26 08:11:20 localhost vdr: [10765] executing '/usr/lib/vdr/vdr-recordingaction started "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:11:20 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom Aug 26 08:12:18 localhost vdr: [1085] PANIC: watchdog timer expired - exiting! Aug 26 08:12:18 localhost vdr: [1085] ERROR: cStateKey::~cStateKey() called without releasing the lock first (tid=1085, lock=1 Timers, key=0x8126f0) Aug 26 08:12:18 localhost vdr: [1085] ABORT! Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr cStateKey::~cStateKey() at thread.c:808 Aug 26 08:12:18 localhost vdr: [1085] /lib/x86_64-linux-gnu/libc.so.6 at exit.c:83 Aug 26 08:12:18 localhost vdr: [1085] /lib/x86_64-linux-gnu/libc.so.6 at ??:? Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr at ??:0 Aug 26 08:12:18 localhost vdr: [1085] /lib/x86_64-linux-gnu/libc.so.6 at ??:? Aug 26 08:12:18 localhost vdr: [1085] /lib/x86_64-linux-gnu/libpthread.so.0 at ??:? Aug 26 08:12:18 localhost vdr: [1085] /lib/x86_64-linux-gnu/libpthread.so.0 pthread_mutex_lock calling __GI___pthread_mutex_lock at ??:? Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr cMutex::Lock() at thread.c:225 Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr cMutexLock::Lock(cMutex*) at thread.c:405 Aug 26 08:12:18 localhost vdr: [1085] /usr/lib/vdr/plugins/libvdr-vnsiserver.so.2.3.8 cVNSIClient::Recording(cDevice const*, char const*, char const*, bool) at vnsiclient.c:304 Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr cStatus::MsgRecording(cDevice const*, char const*, char const*, bool) at status.c:47 (discriminator 2) Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr cRecordControl::cRecordControl(cDevice*, cTimers*, cTimer*, bool) at menu.c:5141 Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr cRecordControls::Start(cTimers*, cTimer*, bool) at menu.c:5255 (discriminator 3) Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr main at vdr.c:1107 Aug 26 08:12:18 localhost vdr: [1085] /lib/x86_64-linux-gnu/libc.so.6 __libc_start_main at libc-start.c:325 Aug 26 08:12:18 localhost vdr: [1085] /usr/bin/vdr _start at ??:? Aug 26 08:12:30 localhost systemd[1]: vdr.service: Main process exited, code=dumped, status=6/ABRT Aug 26 08:12:30 localhost systemd[1]: vdr.service: Unit entered failed state. Aug 26 08:12:30 localhost systemd[1]: vdr.service: Failed with result 'core-dump'. Aug 26 08:12:31 localhost systemd[1]: vdr.service: Service hold-off time over, scheduling restart. Aug 26 08:12:31 localhost systemd[1]: Stopped Video Disk Recorder. Aug 26 08:12:31 localhost systemd[1]: Starting Video Disk Recorder... Aug 26 08:12:31 localhost vdr: [10837] VDR version 2.3.8 started Aug 26 08:12:31 localhost vdr: [10837] switched to user 'vdr' Aug 26 08:12:31 localhost vdr: [10837] codeset is 'UTF-8' - known Aug 26 08:12:31 localhost vdr: [10837] override character table is 'ISO-8859-9' Aug 26 08:12:31 localhost vdr: [10837] found 28 locales in /usr/share/locale Aug 26 08:12:31 localhost vdr: [10837] loading plugin: /usr/lib/vdr/plugins/libvdr-ddci2.so.2.3.8 Aug 26 08:12:31 localhost vdr: [10837] loading plugin: /usr/lib/vdr/plugins/libvdr-streamdev-server.so.2.3.8 Aug 26 08:12:31 localhost vdr: [10837] loading plugin: /usr/lib/vdr/plugins/libvdr-vnsiserver.so.2.3.8 Aug 26 08:12:31 localhost vdr: [10837] loading plugin: /usr/lib/vdr/plugins/libvdr-wirbelscan.so.2.3.8 Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/setup.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/sources.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/diseqc.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/scr.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/channels.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/timers.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/commands.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/reccmds.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/svdrphosts.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/remote.conf Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/keymacros.conf Aug 26 08:12:31 localhost vdr: [10837] registered source parameters for 'A - ATSC' Aug 26 08:12:31 localhost vdr: [10837] registered source parameters for 'C - DVB-C' Aug 26 08:12:31 localhost vdr: [10837] registered source parameters for 'S - DVB-S' Aug 26 08:12:31 localhost vdr: [10837] registered source parameters for 'T - DVB-T' Aug 26 08:12:31 localhost vdr: [10839] video directory scanner thread started (pid=10837, tid=10839, prio=low) Aug 26 08:12:31 localhost vdr: [10837] probing /dev/dvb/adapter0/frontend0 Aug 26 08:12:31 localhost vdr: [10837] creating cDvbDevice Aug 26 08:12:31 localhost vdr: [10837] new device number 1 Aug 26 08:12:31 localhost vdr: [10839] video directory scanner thread ended (pid=10837, tid=10839) Aug 26 08:12:31 localhost vdr: [10840] epg data reader thread started (pid=10837, tid=10840, prio=high) Aug 26 08:12:31 localhost vdr: [10840] reading EPG data from /var/cache/vdr/epg.data Aug 26 08:12:31 localhost vdr: [10837] DVB API version is 0x050A (VDR was built with 0x050A) Aug 26 08:12:31 localhost vdr: [10837] frontend 0/0 provides DVB-S,DVB-S2,DSS with QPSK ("STV090x Multistandard") Aug 26 08:12:31 localhost vdr: [10842] frontend 0/0 tuner thread started (pid=10837, tid=10842, prio=high) Aug 26 08:12:31 localhost vdr: [10842] cTimeMs: using monotonic clock (resolution is 1 ns) Aug 26 08:12:31 localhost vdr: [10837] probing /dev/dvb/adapter1/frontend0 Aug 26 08:12:31 localhost vdr: [10837] creating cDvbDevice Aug 26 08:12:31 localhost vdr: [10837] new device number 2 Aug 26 08:12:31 localhost vdr: [10843] device 1 section handler thread started (pid=10837, tid=10843, prio=low) Aug 26 08:12:31 localhost vdr: [10837] frontend 1/0 provides DVB-S,DVB-S2,DSS with QPSK ("STV090x Multistandard") Aug 26 08:12:31 localhost vdr: [10845] frontend 1/0 tuner thread started (pid=10837, tid=10845, prio=high) Aug 26 08:12:31 localhost vdr: [10837] found 2 DVB devices Aug 26 08:12:31 localhost vdr: [10837] initializing plugin: ddci2 (1.0.5): External Digital Devices CI-Adapter Aug 26 08:12:31 localhost vdr: [10846] device 2 section handler thread started (pid=10837, tid=10846, prio=low) Aug 26 08:12:31 localhost vdr: [10837] initializing plugin: streamdev-server (0.6.1-git): VDR Streaming Server Aug 26 08:12:31 localhost vdr: [10837] initializing plugin: vnsiserver (1.5.2): VDR-Network-Streaming-Interface (VNSI) Server Aug 26 08:12:31 localhost vdr: [10837] initializing plugin: wirbelscan (2017.06.04): DVB channel scan for VDR Aug 26 08:12:31 localhost vdr: [10837] setting primary device to 1 Aug 26 08:12:31 localhost vdr: [10837] device 1 has no MPEG decoder Aug 26 08:12:31 localhost vdr: [10837] assuming manual start of VDR Aug 26 08:12:31 localhost vdr: [10837] setting current skin to "sttng" Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/themes/sttng-default.theme Aug 26 08:12:31 localhost vdr: [10837] starting plugin: ddci2 Aug 26 08:12:31 localhost vdr: [10837] DDCI-Inf: plugin version 1.0.5 initializing (compiled for VDR version 2.3.8) Aug 26 08:12:31 localhost vdr: [10837] DDCI-Inf: found 1 DD CI adapter Aug 26 08:12:31 localhost vdr: [10837] DDCI-Inf: Creating DdCiAdapter 0 (/dev/dvb/adapter2/ca0) Aug 26 08:12:31 localhost kernel: [22524.407775] i2c i2c-9: slot_shutdown Aug 26 08:12:31 localhost vdr: [10840] epg data reader thread ended (pid=10837, tid=10840) Aug 26 08:12:31 localhost vdr: [10837] DDCI-Inf: plugin started Aug 26 08:12:31 localhost vdr: [10837] starting plugin: streamdev-server Aug 26 08:12:31 localhost vdr: [10837] loading /var/lib/vdr/plugins/streamdev-server/streamdevhosts.conf Aug 26 08:12:31 localhost vdr: [10837] starting plugin: vnsiserver Aug 26 08:12:31 localhost vdr: [10837] VNSI: Starting vnsi server at port=34890 Aug 26 08:12:31 localhost vdr: [10847] DDCI adapter /dev/dvb/adapter2/ca0 thread started (pid=10837, tid=10847, prio=high) Aug 26 08:12:31 localhost vdr: [10837] VNSI: VNSI Server started Aug 26 08:12:31 localhost vdr: [10837] VNSI: Channel streaming timeout: 10 seconds Aug 26 08:12:31 localhost vdr: [10837] starting plugin: wirbelscan Aug 26 08:12:31 localhost vdr: [10848] streamdev server thread started (pid=10837, tid=10848, prio=high) Aug 26 08:12:31 localhost vdr: [10850] DDCI Send (/dev/dvb/adapter2/sec0) thread started (pid=10837, tid=10850, prio=high) Aug 26 08:12:31 localhost vdr: [10837] loading /var/cache/vdr/cam.data Aug 26 08:12:31 localhost vdr: [10848] Streamdev: Listening (VTP) on port 2004 Aug 26 08:12:31 localhost vdr: [10848] Streamdev: Listening (HTTP) on port 3000 Aug 26 08:12:31 localhost vdr: [10849] VNSI Server thread started (pid=10837, tid=10849, prio=high) Aug 26 08:12:31 localhost vdr: [10851] DDCI Recv (/dev/dvb/adapter2/sec0) thread started (pid=10837, tid=10851, prio=high) Aug 26 08:12:31 localhost vdr: [10852] DDCI Recv Deliver (/dev/dvb/adapter2/sec0) thread started (pid=10837, tid=10852, prio=high) Aug 26 08:12:31 localhost vdr: [10852] DDCI-Err (ddcitsrecv.cpp,151): skipped 132 bytes to sync on start of TS packet Aug 26 08:12:31 localhost vdr: [10853] VNSIStatus thread started (pid=10837, tid=10853, prio=high) Aug 26 08:12:31 localhost vdr: [10854] VNSITimers thread started (pid=10837, tid=10854, prio=high) Aug 26 08:12:31 localhost vdr: [10852] DDCI-Err (ddcitsrecv.cpp,151): skipped 112 bytes to sync on start of TS packet Aug 26 08:12:31 localhost vdr: [10847] CAM 1: module present Aug 26 08:12:31 localhost vdr: [10849] loading /var/lib/vdr/plugins/vnsiserver/allowed_hosts.conf Aug 26 08:12:31 localhost vdr: [10849] VNSI: Client with ID 0 connected: 127.0.0.1:48272 Aug 26 08:12:31 localhost vdr: [10855] VNSI Client 0->127.0.0.1:48272 thread started (pid=10837, tid=10855, prio=high) Aug 26 08:12:31 localhost vdr: [10855] VNSI: Welcome client 'XBMC Media Center' with protocol version '10' Aug 26 08:12:31 localhost vdr: [10849] loading /var/lib/vdr/plugins/vnsiserver/allowed_hosts.conf Aug 26 08:12:31 localhost vdr: [10849] VNSI: Client with ID 1 connected: 192.168.178.15:46738 Aug 26 08:12:31 localhost vdr: [10858] VNSI Client 1->192.168.178.15:46738 thread started (pid=10837, tid=10858, prio=high) Aug 26 08:12:31 localhost vdr: [10858] VNSI: Welcome client 'XBMC Media Center' with protocol version '10' Aug 26 08:12:33 localhost kernel: [22526.320223] i2c i2c-9: enable cam buffer mode Aug 26 08:12:33 localhost kernel: [22526.334756] dvb_ca_en50221: dvb_ca adapter 2: DVB CAM detected and initialised successfully Aug 26 08:12:33 localhost vdr: [10852] DDCI-Err (ddcitsrecv.cpp,151): skipped 4 bytes to sync on start of TS packet Aug 26 08:12:33 localhost vdr: [10847] CAM 1: module ready Aug 26 08:12:36 localhost vdr: [10847] CAM 1: AlphaCrypt, 01, 4A20, 4A22 Aug 26 08:12:36 localhost vdr: [10847] CAM 1: system ids: 098C Aug 26 08:12:38 localhost vdr: [10847] CAM 1: replies to QUERY - multi channel decryption (MCD) possible Aug 26 08:12:38 localhost vdr: [10847] CAM 1: supports multi transponder decryption (MTD) Aug 26 08:12:38 localhost vdr: [10847] CAM 1: activating MTD support Aug 26 08:12:38 localhost vdr: [10837] CAM 1: ready, master (AlphaCrypt) Aug 26 08:12:38 localhost vdr: [10837] switching to channel 1 S19.2E-1-1101-28106 (Das Erste) Aug 26 08:12:38 localhost systemd[1]: Started Video Disk Recorder. Aug 26 08:12:38 localhost vdr: [10837] setting watchdog timer to 60 seconds Aug 26 08:12:38 localhost vdr: [10862] SVDRP server handler thread started (pid=10837, tid=10862, prio=low) Aug 26 08:12:38 localhost vdr: [10862] SVDRP listening on port 6419/tcp Aug 26 08:12:38 localhost vdr: [10837] OSD size changed to 720x480 @ 1 Aug 26 08:12:39 localhost vdr: [10837] ERROR: no OSD provider available - using dummy OSD! Aug 26 08:12:39 localhost vdr: [10837] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') set to event Sa. 26.08.2017 05:45-08:15 'Batman v Superman: Dawn of Justice' Aug 26 08:12:39 localhost vdr: [10837] timer 2 (130 2312-0135 'Stirb langsam') set to event Sa. 26.08.2017 23:15-01:30 'Stirb langsam' Aug 26 08:12:39 localhost vdr: [10837] timer 3 (134 0202-0430 'Kill Bill: Volume 2') set to event So. 27.08.2017 02:05-04:25 'Kill Bill: Volume 2' Aug 26 08:12:39 localhost vdr: [10837] timer 4 (134 0007-0210 'Kill Bill: Vol. 1') set to event So. 27.08.2017 00:10-02:05 'Kill Bill: Vol. 1' Aug 26 08:12:39 localhost vdr: [10837] CAM 1/1: creating new MTD CAM slot Aug 26 08:12:39 localhost vdr: [10837] CAM 1: assigned to device 1 Aug 26 08:12:39 localhost vdr: [10837] switching device 1 to channel 130 S19.2E-133-3-9 (Sky Cinema Action) Aug 26 08:12:39 localhost vdr: [10863] device 1 receiver thread started (pid=10837, tid=10863, prio=high) Aug 26 08:12:39 localhost vdr: [10864] device 1 TS buffer thread started (pid=10837, tid=10864, prio=high) Aug 26 08:12:39 localhost vdr: [10837] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') start Aug 26 08:12:39 localhost vdr: [10837] Title: 'Batman v Superman: Dawn of Justice' Subtitle: 'Actionfilm' Aug 26 08:12:39 localhost vdr: [10837] executing '/usr/lib/vdr/vdr-recordingaction before "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:12:39 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom before recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:12:39 localhost vdr: [10837] record /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:12:39 localhost vdr: [10837] recording to '/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec/00003.ts' Aug 26 08:12:39 localhost vdr: [10885] recording thread started (pid=10837, tid=10885, prio=high) Aug 26 08:12:39 localhost vdr: [10853] VNSI: Requesting clients to reload timers Aug 26 08:12:39 localhost vdr: [10837] max. latency time 1 seconds Aug 26 08:12:39 localhost vdr: [10853] VNSI: Requesting clients to reload recordings list Aug 26 08:12:40 localhost vdr: [10843] changing pids of channel 130 (Sky Cinema Action) from 767+767=27:768=deu@3,769=eng@3;771=deu@106:0:0 to 767+767=27:768=deu@3;771=deu@106:0:0 Aug 26 08:12:40 localhost vdr: [10853] VNSI: Requesting clients to reload channel list Aug 26 08:12:40 localhost vdr: [10837] stopping recording due to modification of channel 130 (Sky Cinema Action) Aug 26 08:12:41 localhost vdr: [10885] recording thread ended (pid=10837, tid=10885) Aug 26 08:12:41 localhost vdr: [10837] CAM 1: unassigned from device 1 Aug 26 08:12:41 localhost vdr: [10837] buffer stats: 86668 (0%) used Aug 26 08:12:41 localhost vdr: [10837] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') stop Aug 26 08:12:41 localhost vdr: [10837] executing '/usr/lib/vdr/vdr-recordingaction after "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:12:41 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom after recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:12:41 localhost vdr: [10864] device 1 TS buffer thread ended (pid=10837, tid=10864) Aug 26 08:12:41 localhost vdr: [10863] buffer stats: 34404 (0%) used Aug 26 08:12:41 localhost vdr: [10863] device 1 receiver thread ended (pid=10837, tid=10863) Aug 26 08:12:41 localhost vdr: [10837] CAM 1/1: reusing MTD CAM slot Aug 26 08:12:41 localhost vdr: [10837] CAM 1: assigned to device 1 Aug 26 08:12:41 localhost vdr: [10908] device 1 receiver thread started (pid=10837, tid=10908, prio=high) Aug 26 08:12:41 localhost vdr: [10837] switching device 1 to channel 130 S19.2E-133-3-9 (Sky Cinema Action) Aug 26 08:12:41 localhost vdr: [10909] device 1 TS buffer thread started (pid=10837, tid=10909, prio=high) Aug 26 08:12:41 localhost vdr: [10837] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') start Aug 26 08:12:41 localhost vdr: [10837] Title: 'Batman v Superman: Dawn of Justice' Subtitle: 'Actionfilm' Aug 26 08:12:41 localhost vdr: [10837] executing '/usr/lib/vdr/vdr-recordingaction before "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:12:41 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom before recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:12:41 localhost vdr: [10837] record /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:12:41 localhost vdr: [10837] cFileName::SetOffset: removing zero-sized file /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec/00003.ts Aug 26 08:12:41 localhost vdr: [10837] recording to '/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec/00003.ts' Aug 26 08:12:41 localhost vdr: [10930] recording thread started (pid=10837, tid=10930, prio=high) Aug 26 08:12:44 localhost vdr: [10930] executing '/usr/lib/vdr/vdr-recordingaction started "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:12:44 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom Aug 26 08:13:40 localhost vdr: [10837] PANIC: watchdog timer expired - exiting! Aug 26 08:13:40 localhost vdr: [10837] ERROR: cStateKey::~cStateKey() called without releasing the lock first (tid=10837, lock=1 Timers, key=0x8126f0) Aug 26 08:13:40 localhost vdr: [10837] ABORT! Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr cStateKey::~cStateKey() at thread.c:808 Aug 26 08:13:41 localhost vdr: [10837] /lib/x86_64-linux-gnu/libc.so.6 at exit.c:83 Aug 26 08:13:41 localhost vdr: [10837] /lib/x86_64-linux-gnu/libc.so.6 at ??:? Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr at ??:0 Aug 26 08:13:41 localhost vdr: [10837] /lib/x86_64-linux-gnu/libc.so.6 at ??:? Aug 26 08:13:41 localhost vdr: [10837] /lib/x86_64-linux-gnu/libpthread.so.0 at ??:? Aug 26 08:13:41 localhost vdr: [10837] /lib/x86_64-linux-gnu/libpthread.so.0 pthread_mutex_lock calling __GI___pthread_mutex_lock at ??:? Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr cMutex::Lock() at thread.c:225 Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr cMutexLock::Lock(cMutex*) at thread.c:405 Aug 26 08:13:41 localhost vdr: [10837] /usr/lib/vdr/plugins/libvdr-vnsiserver.so.2.3.8 cVNSIClient::Recording(cDevice const*, char const*, char const*, bool) at vnsiclient.c:304 Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr cStatus::MsgRecording(cDevice const*, char const*, char const*, bool) at status.c:47 (discriminator 2) Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr cRecordControl::cRecordControl(cDevice*, cTimers*, cTimer*, bool) at menu.c:5141 Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr cRecordControls::Start(cTimers*, cTimer*, bool) at menu.c:5255 (discriminator 3) Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr main at vdr.c:1107 Aug 26 08:13:41 localhost vdr: [10837] /lib/x86_64-linux-gnu/libc.so.6 __libc_start_main at libc-start.c:325 Aug 26 08:13:41 localhost vdr: [10837] /usr/bin/vdr _start at ??:? Aug 26 08:13:41 localhost systemd[1]: vdr.service: Main process exited, code=dumped, status=6/ABRT Aug 26 08:13:41 localhost systemd[1]: vdr.service: Unit entered failed state. Aug 26 08:13:41 localhost systemd[1]: vdr.service: Failed with result 'core-dump'. Aug 26 08:13:41 localhost systemd[1]: vdr.service: Service hold-off time over, scheduling restart. Aug 26 08:13:41 localhost systemd[1]: Stopped Video Disk Recorder. Aug 26 08:13:41 localhost systemd[1]: Starting Video Disk Recorder... Aug 26 08:13:41 localhost vdr: [11010] VDR version 2.3.8 started Aug 26 08:13:41 localhost vdr: [11010] switched to user 'vdr' Aug 26 08:13:41 localhost vdr: [11010] codeset is 'UTF-8' - known Aug 26 08:13:41 localhost vdr: [11010] override character table is 'ISO-8859-9' Aug 26 08:13:41 localhost vdr: [11010] found 28 locales in /usr/share/locale Aug 26 08:13:41 localhost vdr: [11010] loading plugin: /usr/lib/vdr/plugins/libvdr-ddci2.so.2.3.8 Aug 26 08:13:41 localhost vdr: [11010] loading plugin: /usr/lib/vdr/plugins/libvdr-streamdev-server.so.2.3.8 Aug 26 08:13:41 localhost vdr: [11010] loading plugin: /usr/lib/vdr/plugins/libvdr-vnsiserver.so.2.3.8 Aug 26 08:13:41 localhost vdr: [11010] loading plugin: /usr/lib/vdr/plugins/libvdr-wirbelscan.so.2.3.8 Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/setup.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/sources.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/diseqc.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/scr.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/channels.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/timers.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/commands.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/reccmds.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/svdrphosts.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/remote.conf Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/keymacros.conf Aug 26 08:13:41 localhost vdr: [11010] registered source parameters for 'A - ATSC' Aug 26 08:13:41 localhost vdr: [11010] registered source parameters for 'C - DVB-C' Aug 26 08:13:41 localhost vdr: [11010] registered source parameters for 'S - DVB-S' Aug 26 08:13:41 localhost vdr: [11010] registered source parameters for 'T - DVB-T' Aug 26 08:13:41 localhost vdr: [11012] epg data reader thread started (pid=11010, tid=11012, prio=high) Aug 26 08:13:41 localhost vdr: [11012] reading EPG data from /var/cache/vdr/epg.data Aug 26 08:13:41 localhost vdr: [11010] probing /dev/dvb/adapter0/frontend0 Aug 26 08:13:41 localhost vdr: [11010] creating cDvbDevice Aug 26 08:13:41 localhost vdr: [11010] new device number 1 Aug 26 08:13:41 localhost vdr: [11011] video directory scanner thread started (pid=11010, tid=11011, prio=low) Aug 26 08:13:41 localhost vdr: [11011] video directory scanner thread ended (pid=11010, tid=11011) Aug 26 08:13:41 localhost vdr: [11010] DVB API version is 0x050A (VDR was built with 0x050A) Aug 26 08:13:41 localhost vdr: [11010] frontend 0/0 provides DVB-S,DVB-S2,DSS with QPSK ("STV090x Multistandard") Aug 26 08:13:41 localhost vdr: [11010] cTimeMs: using monotonic clock (resolution is 1 ns) Aug 26 08:13:41 localhost vdr: [11015] device 1 section handler thread started (pid=11010, tid=11015, prio=low) Aug 26 08:13:41 localhost vdr: [11010] probing /dev/dvb/adapter1/frontend0 Aug 26 08:13:41 localhost vdr: [11010] creating cDvbDevice Aug 26 08:13:41 localhost vdr: [11010] new device number 2 Aug 26 08:13:41 localhost vdr: [11014] frontend 0/0 tuner thread started (pid=11010, tid=11014, prio=high) Aug 26 08:13:41 localhost vdr: [11010] frontend 1/0 provides DVB-S,DVB-S2,DSS with QPSK ("STV090x Multistandard") Aug 26 08:13:41 localhost vdr: [11017] frontend 1/0 tuner thread started (pid=11010, tid=11017, prio=high) Aug 26 08:13:41 localhost vdr: [11010] found 2 DVB devices Aug 26 08:13:41 localhost vdr: [11010] initializing plugin: ddci2 (1.0.5): External Digital Devices CI-Adapter Aug 26 08:13:41 localhost vdr: [11018] device 2 section handler thread started (pid=11010, tid=11018, prio=low) Aug 26 08:13:41 localhost vdr: [11010] initializing plugin: streamdev-server (0.6.1-git): VDR Streaming Server Aug 26 08:13:41 localhost vdr: [11010] initializing plugin: vnsiserver (1.5.2): VDR-Network-Streaming-Interface (VNSI) Server Aug 26 08:13:41 localhost vdr: [11010] initializing plugin: wirbelscan (2017.06.04): DVB channel scan for VDR Aug 26 08:13:41 localhost vdr: [11010] setting primary device to 1 Aug 26 08:13:41 localhost vdr: [11010] device 1 has no MPEG decoder Aug 26 08:13:41 localhost vdr: [11010] assuming manual start of VDR Aug 26 08:13:41 localhost vdr: [11010] setting current skin to "sttng" Aug 26 08:13:41 localhost vdr: [11010] loading /var/lib/vdr/themes/sttng-default.theme Aug 26 08:13:41 localhost vdr: [11010] starting plugin: ddci2 Aug 26 08:13:41 localhost vdr: [11010] DDCI-Inf: plugin version 1.0.5 initializing (compiled for VDR version 2.3.8) Aug 26 08:13:41 localhost vdr: [11010] DDCI-Inf: found 1 DD CI adapter Aug 26 08:13:41 localhost vdr: [11010] DDCI-Inf: Creating DdCiAdapter 0 (/dev/dvb/adapter2/ca0) Aug 26 08:13:41 localhost kernel: [22594.918366] i2c i2c-9: slot_shutdown Aug 26 08:13:41 localhost vdr: [11012] epg data reader thread ended (pid=11010, tid=11012) Aug 26 08:13:42 localhost vdr: [11010] DDCI-Inf: plugin started Aug 26 08:13:42 localhost vdr: [11010] starting plugin: streamdev-server Aug 26 08:13:42 localhost vdr: [11010] loading /var/lib/vdr/plugins/streamdev-server/streamdevhosts.conf Aug 26 08:13:42 localhost vdr: [11010] starting plugin: vnsiserver Aug 26 08:13:42 localhost vdr: [11010] VNSI: Starting vnsi server at port=34890 Aug 26 08:13:42 localhost vdr: [11020] streamdev server thread started (pid=11010, tid=11020, prio=high) Aug 26 08:13:42 localhost vdr: [11020] Streamdev: Listening (VTP) on port 2004 Aug 26 08:13:42 localhost vdr: [11010] VNSI: VNSI Server started Aug 26 08:13:42 localhost vdr: [11020] Streamdev: Listening (HTTP) on port 3000 Aug 26 08:13:42 localhost vdr: [11010] VNSI: Channel streaming timeout: 10 seconds Aug 26 08:13:42 localhost vdr: [11019] DDCI adapter /dev/dvb/adapter2/ca0 thread started (pid=11010, tid=11019, prio=high) Aug 26 08:13:42 localhost vdr: [11010] starting plugin: wirbelscan Aug 26 08:13:42 localhost vdr: [11010] loading /var/cache/vdr/cam.data Aug 26 08:13:42 localhost vdr: [11022] DDCI Send (/dev/dvb/adapter2/sec0) thread started (pid=11010, tid=11022, prio=high) Aug 26 08:13:42 localhost vdr: [11021] VNSI Server thread started (pid=11010, tid=11021, prio=high) Aug 26 08:13:42 localhost vdr: [11023] DDCI Recv (/dev/dvb/adapter2/sec0) thread started (pid=11010, tid=11023, prio=high) Aug 26 08:13:42 localhost vdr: [11025] VNSIStatus thread started (pid=11010, tid=11025, prio=high) Aug 26 08:13:42 localhost vdr: [11024] DDCI Recv Deliver (/dev/dvb/adapter2/sec0) thread started (pid=11010, tid=11024, prio=high) Aug 26 08:13:42 localhost vdr: [11026] VNSITimers thread started (pid=11010, tid=11026, prio=high) Aug 26 08:13:42 localhost vdr: [11024] DDCI-Err (ddcitsrecv.cpp,151): skipped 60 bytes to sync on start of TS packet Aug 26 08:13:42 localhost vdr: [11024] DDCI-Err (ddcitsrecv.cpp,151): skipped 172 bytes to sync on start of TS packet Aug 26 08:13:42 localhost vdr: [11019] CAM 1: module present Aug 26 08:13:42 localhost vdr: [11021] loading /var/lib/vdr/plugins/vnsiserver/allowed_hosts.conf Aug 26 08:13:42 localhost vdr: [11021] VNSI: Client with ID 0 connected: 127.0.0.1:48314 Aug 26 08:13:42 localhost vdr: [11027] VNSI Client 0->127.0.0.1:48314 thread started (pid=11010, tid=11027, prio=high) Aug 26 08:13:42 localhost vdr: [11027] VNSI: Welcome client 'XBMC Media Center' with protocol version '10' Aug 26 08:13:42 localhost vdr: [11021] loading /var/lib/vdr/plugins/vnsiserver/allowed_hosts.conf Aug 26 08:13:42 localhost vdr: [11021] VNSI: Client with ID 1 connected: 192.168.178.15:46762 Aug 26 08:13:42 localhost vdr: [11029] VNSI Client 1->192.168.178.15:46762 thread started (pid=11010, tid=11029, prio=high) Aug 26 08:13:42 localhost vdr: [11029] VNSI: Welcome client 'XBMC Media Center' with protocol version '10' Aug 26 08:13:43 localhost kernel: [22596.820258] i2c i2c-9: enable cam buffer mode Aug 26 08:13:43 localhost kernel: [22596.834620] dvb_ca_en50221: dvb_ca adapter 2: DVB CAM detected and initialised successfully Aug 26 08:13:43 localhost vdr: [11024] DDCI-Err (ddcitsrecv.cpp,151): skipped 4 bytes to sync on start of TS packet Aug 26 08:13:44 localhost vdr: [11019] CAM 1: module ready Aug 26 08:13:46 localhost vdr: [11019] CAM 1: AlphaCrypt, 01, 4A20, 4A22 Aug 26 08:13:47 localhost vdr: [11019] CAM 1: system ids: 098C Aug 26 08:13:49 localhost vdr: [11019] CAM 1: replies to QUERY - multi channel decryption (MCD) possible Aug 26 08:13:49 localhost vdr: [11019] CAM 1: supports multi transponder decryption (MTD) Aug 26 08:13:49 localhost systemd[1]: Started Video Disk Recorder. Aug 26 08:13:49 localhost vdr: [11019] CAM 1: activating MTD support Aug 26 08:13:49 localhost vdr: [11010] CAM 1: ready, master (AlphaCrypt) Aug 26 08:13:49 localhost vdr: [11010] switching to channel 1 S19.2E-1-1101-28106 (Das Erste) Aug 26 08:13:49 localhost vdr: [11010] setting watchdog timer to 60 seconds Aug 26 08:13:49 localhost vdr: [11033] SVDRP server handler thread started (pid=11010, tid=11033, prio=low) Aug 26 08:13:49 localhost vdr: [11033] SVDRP listening on port 6419/tcp Aug 26 08:13:49 localhost vdr: [11010] OSD size changed to 720x480 @ 1 Aug 26 08:13:49 localhost vdr: [11010] ERROR: no OSD provider available - using dummy OSD! Aug 26 08:13:49 localhost vdr: [11010] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') set to event Sa. 26.08.2017 05:45-08:15 'Batman v Superman: Dawn of Justice' Aug 26 08:13:49 localhost vdr: [11010] timer 2 (130 2312-0135 'Stirb langsam') set to event Sa. 26.08.2017 23:15-01:30 'Stirb langsam' Aug 26 08:13:49 localhost vdr: [11010] timer 3 (134 0202-0430 'Kill Bill: Volume 2') set to event So. 27.08.2017 02:05-04:25 'Kill Bill: Volume 2' Aug 26 08:13:49 localhost vdr: [11010] timer 4 (134 0007-0210 'Kill Bill: Vol. 1') set to event So. 27.08.2017 00:10-02:05 'Kill Bill: Vol. 1' Aug 26 08:13:49 localhost vdr: [11010] CAM 1/1: creating new MTD CAM slot Aug 26 08:13:49 localhost vdr: [11010] CAM 1: assigned to device 1 Aug 26 08:13:49 localhost vdr: [11010] switching device 1 to channel 130 S19.2E-133-3-9 (Sky Cinema Action) Aug 26 08:13:49 localhost vdr: [11034] device 1 receiver thread started (pid=11010, tid=11034, prio=high) Aug 26 08:13:49 localhost vdr: [11035] device 1 TS buffer thread started (pid=11010, tid=11035, prio=high) Aug 26 08:13:50 localhost vdr: [11010] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') start Aug 26 08:13:50 localhost vdr: [11010] Title: 'Batman v Superman: Dawn of Justice' Subtitle: 'Actionfilm' Aug 26 08:13:50 localhost vdr: [11010] executing '/usr/lib/vdr/vdr-recordingaction before "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:13:50 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom before recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:13:50 localhost vdr: [11010] record /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:13:50 localhost vdr: [11010] recording to '/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec/00004.ts' Aug 26 08:13:50 localhost vdr: [11056] recording thread started (pid=11010, tid=11056, prio=high) Aug 26 08:13:50 localhost vdr: [11025] VNSI: Requesting clients to reload timers Aug 26 08:13:50 localhost vdr: [11025] VNSI: Requesting clients to reload recordings list Aug 26 08:13:51 localhost vdr: [11010] max. latency time 2 seconds Aug 26 08:13:51 localhost vdr: [11015] channel 130 (Sky Cinema Action) event Sa. 26.08.2017 08:15-09:45 'Autobahnraser' status 4 Aug 26 08:13:51 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:13:52 localhost vdr: [11010] stopping recording due to modification of channel 130 (Sky Cinema Action) Aug 26 08:13:52 localhost vdr: [11056] recording thread ended (pid=11010, tid=11056) Aug 26 08:13:52 localhost vdr: [11010] CAM 1: unassigned from device 1 Aug 26 08:13:52 localhost vdr: [11010] buffer stats: 105656 (0%) used Aug 26 08:13:52 localhost vdr: [11010] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') stop Aug 26 08:13:52 localhost vdr: [11010] executing '/usr/lib/vdr/vdr-recordingaction after "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:13:52 localhost vdr: [11035] device 1 TS buffer thread ended (pid=11010, tid=11035) Aug 26 08:13:52 localhost vdr: [11024] DDCI-Err (ddcitsrecv.cpp,151): skipped 102 bytes to sync on start of TS packet Aug 26 08:13:52 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom after recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:13:52 localhost vdr: [11034] buffer stats: 55836 (1%) used Aug 26 08:13:52 localhost vdr: [11034] device 1 receiver thread ended (pid=11010, tid=11034) Aug 26 08:13:53 localhost vdr: [11010] CAM 1/1: reusing MTD CAM slot Aug 26 08:13:53 localhost vdr: [11010] CAM 1: assigned to device 1 Aug 26 08:13:53 localhost vdr: [11010] switching device 1 to channel 130 S19.2E-133-3-9 (Sky Cinema Action) Aug 26 08:13:53 localhost vdr: [11079] device 1 receiver thread started (pid=11010, tid=11079, prio=high) Aug 26 08:13:53 localhost vdr: [11010] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') start Aug 26 08:13:53 localhost vdr: [11010] Title: 'Batman v Superman: Dawn of Justice' Subtitle: 'Actionfilm' Aug 26 08:13:53 localhost vdr: [11010] executing '/usr/lib/vdr/vdr-recordingaction before "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:13:53 localhost vdr: [11081] device 1 TS buffer thread started (pid=11010, tid=11081, prio=high) Aug 26 08:13:53 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom before recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:13:53 localhost vdr: [11010] record /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:13:53 localhost vdr: [11010] cFileName::SetOffset: removing zero-sized file /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec/00004.ts Aug 26 08:13:53 localhost vdr: [11010] recording to '/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec/00004.ts' Aug 26 08:13:53 localhost vdr: [11101] recording thread started (pid=11010, tid=11101, prio=high) Aug 26 08:13:53 localhost vdr: [11025] VNSI: Requesting clients to reload timers Aug 26 08:13:53 localhost vdr: [11025] VNSI: Requesting clients to reload recordings list Aug 26 08:13:53 localhost vdr: [11015] changing pids of channel 87 (Disney Junior) from 1535+1535=27:1536=deu@3:0:0 to 1535+1535=27:1536=deu@3,1537=eng@3:0:0 Aug 26 08:13:54 localhost vdr: [11015] changing pids of channel 131 (Sky Cinema Comedy) from 1023+1023=27:1024=deu@3,1025=eng@3;1027=deu@106:0:0 to 1023+1023=27:1024=deu@3;1027=deu@106:0:0 Aug 26 08:13:55 localhost vdr: [11010] max. latency time 3 seconds Aug 26 08:13:55 localhost vdr: [11101] executing '/usr/lib/vdr/vdr-recordingaction started "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:13:55 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom Aug 26 08:13:56 localhost vdr: [11015] changing portal name of channel 201 (Sky Select) from '' to 'Sky Select' Aug 26 08:13:56 localhost vdr: [11015] linking channel 201 (Sky Select) from none to 210 203 209 208 Aug 26 08:13:56 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:15:06 localhost vdr: [11015] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:15:06 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:16:28 localhost vdr: message repeated 2 times: [ [11025] VNSI: Requesting clients to reload channel list] Aug 26 08:16:29 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 202 208 to 210 203 209 208 Aug 26 08:16:30 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:16:33 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:17:01 localhost CRON[11117]: (root) CMD ( cd / && run-parts --report /etc/cron.hourly) Aug 26 08:17:10 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:17:11 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 202 208 to 210 203 209 208 Aug 26 08:17:12 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:17:15 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:18:34 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 202 208 to 210 203 209 208 Aug 26 08:18:34 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:18:35 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:18:39 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:18:55 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:18:55 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 202 208 to 210 203 209 208 Aug 26 08:18:56 localhost vdr: [11018] channel 134 (Sky Cinema Hits) event Sa. 26.08.2017 08:00-09:45 'Godsend' status 4 Aug 26 08:18:56 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:19:00 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:19:14 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:19:16 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 202 208 to 210 203 209 208 Aug 26 08:19:17 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:19:19 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:19:35 localhost vdr: [11015] linking channel 201 (Sky Select) from 210 203 209 202 208 to 210 203 209 208 Aug 26 08:19:35 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:19:36 localhost vdr: [11015] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:19:40 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:19:58 localhost vdr: [11018] changing pids of channel 103 (Boomerang) from 4351+4351=27:4352=deu@3,4353=eng@3:0:0 to 4351+4351=27:4352=deu@3:0:0 Aug 26 08:19:58 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 202 208 to 210 203 209 208 Aug 26 08:19:58 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:19:58 localhost vdr: [11018] changing pids of channel 213 (Sky Select HD) from 767+767=27:0;771=deu@106,772=eng@106:0:0 to 767+767=27:0;771=deu@106:0:0 Aug 26 08:19:59 localhost vdr: [11018] changing pids of channel 112 (E! Entertainm. HD) from 255+255=27:0;259=deu@106:0:0 to 255+255=27:0;259=deu@106,260=eng@106:0:0 Aug 26 08:19:59 localhost vdr: [11018] changing pids of channel 94 (Motorvision TV) from 1279+1279=27:1280=deu@3:0:0 to 1279+1279=27:1280=deu@3,1281=eng@3:0:0 Aug 26 08:19:59 localhost vdr: [11018] linking channel 201 (Sky Select) from 210 203 209 208 to 210 203 209 202 208 Aug 26 08:20:00 localhost vdr: [11101] recording thread ended (pid=11010, tid=11101) Aug 26 08:20:00 localhost vdr: [11010] CAM 1: unassigned from device 1 Aug 26 08:20:00 localhost vdr: [11010] buffer stats: 129156 (0%) used Aug 26 08:20:00 localhost vdr: [11010] timer 1 (130 0542-0820 'Batman v Superman: Dawn of Justice') stop Aug 26 08:20:00 localhost vdr: [11010] executing '/usr/lib/vdr/vdr-recordingaction after "/home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec"' Aug 26 08:20:00 localhost recordingaction: executing /usr/share/vdr/recording-hooks/R90.custom after recording /home/kodi/Aufnahmen/Batman_v_Superman#3A_Dawn_of_Justice/2017-08-26.05.42.130-0.rec Aug 26 08:20:00 localhost vdr: [11081] device 1 TS buffer thread ended (pid=11010, tid=11081) Aug 26 08:20:00 localhost vdr: [11079] buffer stats: 85164 (1%) used Aug 26 08:20:00 localhost vdr: [11079] device 1 receiver thread ended (pid=11010, tid=11079) Aug 26 08:20:00 localhost vdr: [11025] VNSI: Requesting clients to reload timers Aug 26 08:20:03 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:20:20 localhost vdr: [11015] changing pids of channel 110 (Discovery HD) from 1023+1023=27:0;1027=deu@106,1028=eng@106:0:0 to 1023+1023=27:0;1027=deu@106:0:0 Aug 26 08:20:20 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:20:25 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:20:41 localhost vdr: [11018] changing pids of channel 86 (Discovery Channel) from 3327+3327=27:3328=deu@3,3329=eng@3:0:0 to 3327+3327=27:3328=deu@3:0:0 Aug 26 08:20:41 localhost vdr: [11025] VNSI: Requesting clients to reload channel list Aug 26 08:20:46 localhost vdr: [11025] VNSI: Requesting clients to reload channel list