Okt 16 01:03:07 [general.debug] logfile '/var/log/vdr-sc' opened Okt 16 01:03:07 [general.info] SC version 0.8.4 initializing Okt 16 01:03:07 [general.debug] probing /dev/dvb/adapter0/frontend0 Okt 16 01:03:07 [general.debug] capturing device 0 Okt 16 01:03:07 [general.info] captured 1 video device Okt 16 01:03:09 [general.info] SC version 0.8.4 starting Okt 16 01:03:09 [core.load] ** Plugin config: Okt 16 01:03:09 [core.load] ** Key updates (AU) are enabled (active CAIDs) Okt 16 01:03:09 [core.load] ** Local systems DON'T take priority over cached remote Okt 16 01:03:09 [core.load] ** Concurrent FF recordings are allowed Okt 16 01:03:09 [core.load] ** Force transfermode with digital audio Okt 16 01:03:09 [core.load] ** ScCaps are 1 2 0 0 0 0 0 0 0 0 Okt 16 01:03:09 [core.load] ** Ignored CAIDs 0000 0000 0000 0000 0000 0000 0000 0000 0000 0000 0000 0000 0000 0000 0000 0000 Okt 16 01:03:09 [general.info] loading keys from /etc/vdr/plugins/SoftCam.Key Okt 16 01:03:09 [core.load] loaded 29 keys from /etc/vdr/plugins/SoftCam.Key Okt 16 01:03:09 [core.load] ** registered systems: Okt 16 01:03:09 [core.load] ** Viaccess (pri -10) Okt 16 01:03:09 [core.load] ** @SHL (pri -10) Okt 16 01:03:09 [core.load] ** Seca (pri -10) Okt 16 01:03:09 [core.load] ** SC-VideoGuard2 (pri -5) Okt 16 01:03:09 [core.load] ** SC-Viaccess (pri -5) Okt 16 01:03:09 [core.load] ** SC-Seca (pri -5) Okt 16 01:03:09 [core.load] ** SC-Nagra (pri -5) Okt 16 01:03:09 [core.load] ** SC-Irdeto (pri -5) Okt 16 01:03:09 [core.load] ** SC-Cryptoworks (pri -5) Okt 16 01:03:09 [core.load] ** SC-Conax (pri -5) Okt 16 01:03:09 [core.load] ** Nagra (pri -10) Okt 16 01:03:09 [core.load] ** Nagra2 (pri -10) Okt 16 01:03:09 [core.load] ** Irdeto (pri -10) Okt 16 01:03:09 [core.load] ** Cryptoworks (pri -10) Okt 16 01:03:09 [core.load] ** ConstCW (pri -20) Okt 16 01:03:09 [core.load] ** Conax (pri -10) Okt 16 01:03:09 [core.load] ** Cardclient (pri -15) Okt 16 01:03:09 [general.info] loading Viaccess card infos from /etc/vdr/plugins/Viaccess.KID Okt 16 01:03:09 [core.load] loaded 5 Viaccess cards from /etc/vdr/plugins/Viaccess.KID Okt 16 01:03:09 [general.info] loading Seca card infos from /etc/vdr/plugins/Seca.KID Okt 16 01:03:09 [core.load] loaded 0 Seca cards from /etc/vdr/plugins/Seca.KID Okt 16 01:03:09 [general.info] loading Irdeto card infos from /etc/vdr/plugins/Ird-Beta.KID Okt 16 01:03:09 [core.load] loaded 0 Irdeto cards from /etc/vdr/plugins/Ird-Beta.KID Okt 16 01:03:09 [general.info] loading cardclient config from /etc/vdr/plugins/cardclient.conf Okt 16 01:03:09 [cardclient.core] created 0 client(s) Okt 16 01:03:09 [general.info] loading smartcard data from /etc/vdr/plugins/smartcard.conf Okt 16 01:03:09 [general.warn] no smartcard interface defined! Okt 16 01:03:11 [core.pids] 0: now tuned to source 88c0 transponder 1b4dd Okt 16 01:03:11 [core.pids] 0: livepids video=0065 audio=0000 Okt 16 01:03:11 [core.pids] 0: livepids video=0065 audio=0066 Okt 16 01:03:42 [core.pids] 0: add SID 1503 (zero=0 noshift=0) Okt 16 01:03:42 [core.pids] 0: SID=1503 zero=0 | sid=-/-/- zero=-/-/- idle=-/-/- Okt 16 01:03:42 [core.pids] 0: found handler for SID 1503 (0.1 idle=1 idx=1) Okt 16 01:03:42 [core.ecm] 0.1: setting new SID 1503 Okt 16 01:03:42 [core.pids] 0.1: pids on entry Okt 16 01:03:42 [core.pids] 0.1: pids after delete Okt 16 01:03:42 [core.pids] 0.1: pids after add Okt 16 01:03:42 [core.ecm] 0.1: is idle Okt 16 01:03:42 [core.pids] 0: now tuned to source 8882 transponder 337b8 Okt 16 01:03:42 [core.ecm] 0.1: stop Okt 16 01:03:42 [core.pids] 0: livepids video=0065 audio=0000 Okt 16 01:03:42 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:03:42 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:03:42 [core.pids] 0: livepids video=0140 audio=014a Okt 16 01:03:42 [core.ecm] 0.1: triggered SID -1/-1 idx -1/1 mode -1/-1 - Okt 16 01:03:42 [core.pids] 0: add SID 1503 (zero=1 noshift=0) Okt 16 01:03:42 [core.pids] 0: pids VIDEO=0140 AUDIO=014a Okt 16 01:03:42 [core.pids] 0: SID=1503 zero=1 | sid=-/-/- zero=-/-/- idle=1/-1/1 Okt 16 01:03:42 [core.pids] 0.1: shifting cwIndex from 1 to 0 Okt 16 01:03:42 [core.pids] 0: found handler for SID 1503 (0.0 idle=1 idx=0) Okt 16 01:03:42 [core.ecm] 0.0: setting new SID 1503 Okt 16 01:03:42 [core.pids] 0.0: pids on entry Okt 16 01:03:42 [core.pids] 0.0: pids after delete Okt 16 01:03:42 [core.pids] 0: descrambling pid 0140 on index 0 Okt 16 01:03:42 [core.pids] 0: descrambling pid 014a on index 0 Okt 16 01:03:42 [core.pids] 0.0: pids after add VIDEO=0140 AUDIO=014a Okt 16 01:03:42 [core.ecm] 0.0: is no longer idle Okt 16 01:03:42 [core.ecm] 0.0: triggered SID -1/1503 idx 1/0 mode -1/0 - Okt 16 01:03:44 [core.pids] 0: tune to same source/transponder Okt 16 01:03:44 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:03:44 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:03:44 [core.ecm] 0.0: got CaDescriptors for SID 1503 (len=138) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 05 00 e1 68 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:03:44 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 168 (new) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 05 00 e1 6a 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:03:44 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 16a (new) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 05 00 e1 6c 10 01 00 13 01 20 14 03 00 81 08 Okt 16 01:03:44 [core.ecm] 0.0: found 0500 (Viaccess) id 8100 with ecm 16c (new) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 05 00 e1 70 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:03:44 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 170 (new) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 05 00 e1 71 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:03:44 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 171 (new) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 05 00 e1 69 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:03:44 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 169 (new) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 05 00 e1 73 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:03:44 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 173 (new) Okt 16 01:03:44 [core.ecm] 0.0: descriptor 01 00 e1 6b 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:03:44 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 16b (new) Okt 16 01:03:45 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 168 (pri=-10) Okt 16 01:03:45 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:03:45 [core.pids] 0: livepids video=0140 audio=014a Okt 16 01:03:45 [viaccess.time] 8882:337b8: created new transpondertime Okt 16 01:03:45 [core.hook] 0: starting hook 'sattime' (50001) Okt 16 01:03:45 [core.hook] 0: added filter pid=0x0014 sct=0x71/0xff/0x03 idle=15000 crc=0 Okt 16 01:03:45 [viaccess.time] added hook Okt 16 01:03:45 [core.pids] 0: update SID 1503 (zero=1 noshift=0) Okt 16 01:03:45 [core.pids] 0: pids VIDEO=0140 AUDIO=014a Okt 16 01:03:45 [core.pids] 0: SID=1503 zero=1 | sid=0/1503/0 zero=0/1503/0 idle=-/-/- Okt 16 01:03:45 [core.pids] 0: found handler for SID 1503 (0.0 idle=0 idx=0) Okt 16 01:03:45 [core.pids] 0.0: pids on entry VIDEO=0140 AUDIO=014a Okt 16 01:03:45 [core.pids] 0.0: pids after delete VIDEO=0140 AUDIO=014a Okt 16 01:03:45 [core.pids] 0.0: pids after add VIDEO=0140 AUDIO=014a Okt 16 01:03:45 [core.au] 0: chain caid 0500 -> Viaccess(-10) [0032-8b/fe/07] Okt 16 01:03:45 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] Okt 16 01:03:45 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] Okt 16 01:03:45 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] [0035-8b/fe/07] Okt 16 01:03:45 [core.au] 0: starting chain 0500 Okt 16 01:03:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:03:44 2007 (delta -2) Okt 16 01:03:46 [viaccess.tpsau] TPS AU triggered Okt 16 01:03:46 [core.hook] 0: starting hook 'tpsau' (50002) Okt 16 01:03:46 [core.hook] 0: added filter pid=0x0000 sct=0x00/0xff/0x00 idle=15000 crc=0 Okt 16 01:03:46 [viaccess.tpsau] TPS AU hook added Okt 16 01:03:46 [viaccess.key] missing 7c00 TPS key Okt 16 01:03:46 [viaccess.tps] no TPS key available for current time of day Okt 16 01:03:46 [core.ecm] 0.0: triggered SID 1503/1503 idx 0/0 mode 3/0 - Okt 16 01:03:46 [viaccess.key] missing 7c00 TPS key Okt 16 01:03:46 [viaccess.tps] no TPS key available for current time of day Okt 16 01:03:46 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 16a (pri=-10) Okt 16 01:03:46 [core.ecm] system: no key found for V 22600 08 Okt 16 01:03:46 [viaccess.tpsau] got PMT pid 12c0 for SID 12c0 Okt 16 01:03:46 [viaccess.tpsau] got AU pid 12f2 Okt 16 01:03:46 [core.ecm] 0.0: try system Viaccess (0500) id 8100 with ecm 16c (pri=-10) Okt 16 01:03:46 [core.ecm] system: no key found for V 8100 08 Okt 16 01:03:46 [viaccess.tpsau] received complete OpenTV module ID 2 Okt 16 01:03:46 [viaccess.tpsau] processing TPS AU data Okt 16 01:03:46 [viaccess.tpsau] registered callbacks for algo 3 Okt 16 01:03:46 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 170 (pri=-10) Okt 16 01:03:46 [core.ecm] system: no key found for V 20000 08 Okt 16 01:03:47 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 171 (pri=-10) Okt 16 01:03:47 [core.ecm] system: no key found for V 8300 08 Okt 16 01:03:47 [core.ecm] 0.0: try system Viaccess (0500) id 22610 with ecm 169 (pri=-10) Okt 16 01:03:47 [viaccess.tpsau] got 120 keys from AU data Okt 16 01:03:47 [viaccess.tps] 120 TPS keys available (from Okt 15 05:21:00 to Okt 16 05:09:00) Okt 16 01:03:47 [core.load] saved cache to file Okt 16 01:03:47 [core.hook] 0: stopping hook 'tpsau' (50002) Okt 16 01:03:47 [core.ecm] system: no key found for V 22610 08 Okt 16 01:03:47 [core.ecm] 0.0: try system Viaccess (0500) id 20010 with ecm 173 (pri=-10) Okt 16 01:03:47 [core.ecm] system: no key found for V 20010 08 Okt 16 01:03:48 [core.ecm] 0.0: try system Seca (0100) id 0084 with ecm 16b (pri=-10) Okt 16 01:03:48 [seca.ecm] Seca2 provider 0084 not supported Okt 16 01:03:48 [core.ecm] 0.0: got CaDescriptors for SID 1503 (len=138) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 05 00 e1 68 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:03:48 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 168 (already present) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 05 00 e1 6a 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:03:48 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 16a (already present) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 05 00 e1 6c 10 01 00 13 01 20 14 03 00 81 08 Okt 16 01:03:48 [core.ecm] 0.0: found 0500 (Viaccess) id 8100 with ecm 16c (already present) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 05 00 e1 70 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:03:48 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 170 (already present) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 05 00 e1 71 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:03:48 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 171 (already present) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 05 00 e1 69 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:03:48 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 169 (already present) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 05 00 e1 73 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:03:48 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 173 (already present) Okt 16 01:03:48 [core.ecm] 0.0: descriptor 01 00 e1 6b 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:03:48 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 16b (already present) Okt 16 01:03:48 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 168 (pri=-10) Okt 16 01:03:48 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:03:48 [core.ecm] system: no key found for V 7c00 08 Okt 16 01:03:48 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 16a (pri=-10) Okt 16 01:03:48 [core.ecm] system: no key found for V 22600 08 Okt 16 01:03:49 [core.ecm] 0.0: try system Viaccess (0500) id 8100 with ecm 16c (pri=-10) Okt 16 01:03:49 [core.ecm] system: no key found for V 8100 08 Okt 16 01:03:49 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 170 (pri=-10) Okt 16 01:03:49 [core.ecm] system: no key found for V 20000 08 Okt 16 01:03:49 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 171 (pri=-10) Okt 16 01:03:49 [core.ecm] system: no key found for V 8300 08 Okt 16 01:03:50 [core.ecm] 0.0: try system Viaccess (0500) id 22610 with ecm 169 (pri=-10) Okt 16 01:03:50 [core.ecm] system: no key found for V 22610 08 Okt 16 01:03:50 [core.ecm] 0.0: try system Viaccess (0500) id 20010 with ecm 173 (pri=-10) Okt 16 01:03:50 [core.ecm] system: no key found for V 20010 08 Okt 16 01:03:50 [core.ecm] 0.0: try system Seca (0100) id 0084 with ecm 16b (pri=-10) Okt 16 01:03:50 [seca.ecm] Seca2 provider 0084 not supported Okt 16 01:03:50 [core.ecm] 0.0: got CaDescriptors for SID 1503 (len=138) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 05 00 e1 68 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:03:50 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 168 (already present) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 05 00 e1 6a 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:03:50 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 16a (already present) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 05 00 e1 6c 10 01 00 13 01 20 14 03 00 81 08 Okt 16 01:03:50 [core.ecm] 0.0: found 0500 (Viaccess) id 8100 with ecm 16c (already present) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 05 00 e1 70 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:03:50 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 170 (already present) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 05 00 e1 71 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:03:50 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 171 (already present) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 05 00 e1 69 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:03:50 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 169 (already present) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 05 00 e1 73 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:03:50 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 173 (already present) Okt 16 01:03:50 [core.ecm] 0.0: descriptor 01 00 e1 6b 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:03:50 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 16b (already present) Okt 16 01:03:50 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 168 (pri=-10) Okt 16 01:03:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:03:50 2007 (delta -2) Okt 16 01:03:54 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:03:54 [core.ecm] system: no key found for V 7c00 08 Okt 16 01:03:54 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 16a (pri=-10) Okt 16 01:03:54 [core.ecm] system: no key found for V 22600 08 Okt 16 01:03:55 [core.ecm] 0.0: try system Viaccess (0500) id 8100 with ecm 16c (pri=-10) Okt 16 01:03:55 [core.ecm] system: no key found for V 8100 08 Okt 16 01:03:55 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 170 (pri=-10) Okt 16 01:03:55 [core.ecm] system: no key found for V 20000 08 Okt 16 01:03:55 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 171 (pri=-10) Okt 16 01:03:55 [core.ecm] system: no key found for V 8300 08 Okt 16 01:03:56 [core.ecm] 0.0: try system Viaccess (0500) id 22610 with ecm 169 (pri=-10) Okt 16 01:03:56 [core.ecm] system: no key found for V 22610 08 Okt 16 01:03:56 [core.ecm] 0.0: try system Viaccess (0500) id 20010 with ecm 173 (pri=-10) Okt 16 01:03:56 [core.ecm] system: no key found for V 20010 08 Okt 16 01:03:56 [core.ecm] 0.0: try system Seca (0100) id 0084 with ecm 16b (pri=-10) Okt 16 01:03:56 [seca.ecm] Seca2 provider 0084 not supported Okt 16 01:03:56 [core.ecm] 0.0: got CaDescriptors for SID 1503 (len=138) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 05 00 e1 68 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:03:56 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 168 (already present) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 05 00 e1 6a 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:03:56 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 16a (already present) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 05 00 e1 6c 10 01 00 13 01 20 14 03 00 81 08 Okt 16 01:03:56 [core.ecm] 0.0: found 0500 (Viaccess) id 8100 with ecm 16c (already present) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 05 00 e1 70 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:03:56 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 170 (already present) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 05 00 e1 71 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:03:56 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 171 (already present) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 05 00 e1 69 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:03:56 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 169 (already present) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 05 00 e1 73 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:03:56 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 173 (already present) Okt 16 01:03:56 [core.ecm] 0.0: descriptor 01 00 e1 6b 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:03:56 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 16b (already present) Okt 16 01:03:56 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 168 (pri=-10) Okt 16 01:03:56 [core.ecm] 0.0: stopping message log until valid key is found Okt 16 01:03:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:03:56 2007 (delta -2) Okt 16 01:04:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:02 2007 (delta -2) Okt 16 01:04:04 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:04:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:08 2007 (delta -2) Okt 16 01:04:14 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:04:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:14 2007 (delta -2) Okt 16 01:04:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:20 2007 (delta -2) Okt 16 01:04:24 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:04:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:26 2007 (delta -2) Okt 16 01:04:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:32 2007 (delta -2) Okt 16 01:04:34 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:04:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:38 2007 (delta -2) Okt 16 01:04:45 [core.auStats] EMM packet load average (1/4/10min) 795 199 79 pks/s Okt 16 01:04:45 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:04:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:44 2007 (delta -2) Okt 16 01:04:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:50 2007 (delta -2) Okt 16 01:04:55 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:04:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:04:56 2007 (delta -2) Okt 16 01:05:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:02 2007 (delta -2) Okt 16 01:05:05 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:05:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:08 2007 (delta -2) Okt 16 01:05:15 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:05:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:14 2007 (delta -2) Okt 16 01:05:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:20 2007 (delta -2) Okt 16 01:05:25 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:05:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:26 2007 (delta -2) Okt 16 01:05:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:32 2007 (delta -2) Okt 16 01:05:35 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:05:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:38 2007 (delta -2) Okt 16 01:05:45 [core.auStats] EMM packet load average (1/4/10min) 838 408 163 pks/s Okt 16 01:05:45 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:05:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:44 2007 (delta -2) Okt 16 01:05:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:50 2007 (delta -2) Okt 16 01:05:55 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:05:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:05:56 2007 (delta -2) Okt 16 01:06:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:02 2007 (delta -2) Okt 16 01:06:05 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:06:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:08 2007 (delta -2) Okt 16 01:06:16 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:06:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:14 2007 (delta -2) Okt 16 01:06:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:20 2007 (delta -2) Okt 16 01:06:26 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:06:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:26 2007 (delta -2) Okt 16 01:06:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:32 2007 (delta -2) Okt 16 01:06:36 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:06:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:38 2007 (delta -2) Okt 16 01:06:45 [core.auStats] EMM packet load average (1/4/10min) 842 514 205 pks/s Okt 16 01:06:46 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:06:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:44 2007 (delta -2) Okt 16 01:06:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:50 2007 (delta -2) Okt 16 01:06:56 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:06:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:06:56 2007 (delta -2) Okt 16 01:07:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:02 2007 (delta -2) Okt 16 01:07:06 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:07:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:08 2007 (delta -2) Okt 16 01:07:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:14 2007 (delta -2) Okt 16 01:07:16 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:07:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:20 2007 (delta -2) Okt 16 01:07:26 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:07:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:26 2007 (delta -2) Okt 16 01:07:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:32 2007 (delta -2) Okt 16 01:07:36 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:07:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:38 2007 (delta -2) Okt 16 01:07:45 [core.auStats] EMM packet load average (1/4/10min) 813 717 287 pks/s Okt 16 01:07:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:44 2007 (delta -2) Okt 16 01:07:46 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:07:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:50 2007 (delta -2) Okt 16 01:07:57 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:07:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:07:56 2007 (delta -2) Okt 16 01:08:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:02 2007 (delta -2) Okt 16 01:08:07 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:08:07 [viaccess.tpsau] purging TPS keylist Okt 16 01:08:07 [viaccess.tps] 26 TPS keys available (from Okt 16 00:09:00 to Okt 16 05:09:00) Okt 16 01:08:07 [core.load] saved cache to file Okt 16 01:08:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:08 2007 (delta -2) Okt 16 01:08:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:14 2007 (delta -2) Okt 16 01:08:17 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:08:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:20 2007 (delta -2) Okt 16 01:08:27 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:08:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:26 2007 (delta -2) Okt 16 01:08:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:32 2007 (delta -2) Okt 16 01:08:37 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:08:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:38 2007 (delta -2) Okt 16 01:08:45 [core.auStats] EMM packet load average (1/4/10min) 800 814 367 pks/s Okt 16 01:08:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:44 2007 (delta -2) Okt 16 01:08:47 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:08:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:50 2007 (delta -2) Okt 16 01:08:57 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:08:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:08:56 2007 (delta -2) Okt 16 01:09:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:02 2007 (delta -2) Okt 16 01:09:07 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:09:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:08 2007 (delta -2) Okt 16 01:09:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:14 2007 (delta -2) Okt 16 01:09:17 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:09:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:20 2007 (delta -2) Okt 16 01:09:27 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:09:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:26 2007 (delta -2) Okt 16 01:09:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:32 2007 (delta -2) Okt 16 01:09:38 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:09:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:38 2007 (delta -2) Okt 16 01:09:45 [core.auStats] EMM packet load average (1/4/10min) 766 805 443 pks/s Okt 16 01:09:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:44 2007 (delta -2) Okt 16 01:09:48 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:09:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:50 2007 (delta -2) Okt 16 01:09:58 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:09:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:09:56 2007 (delta -2) Okt 16 01:10:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:02 2007 (delta -2) Okt 16 01:10:08 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:10:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:08 2007 (delta -2) Okt 16 01:10:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:14 2007 (delta -2) Okt 16 01:10:18 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:10:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:20 2007 (delta -2) Okt 16 01:10:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:26 2007 (delta -2) Okt 16 01:10:28 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:10:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:32 2007 (delta -2) Okt 16 01:10:38 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:10:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:38 2007 (delta -2) Okt 16 01:10:45 [core.auStats] EMM packet load average (1/4/10min) 850 807 528 pks/s Okt 16 01:10:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:44 2007 (delta -2) Okt 16 01:10:48 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:10:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:50 2007 (delta -2) Okt 16 01:10:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:10:56 2007 (delta -2) Okt 16 01:10:58 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:11:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:02 2007 (delta -2) Okt 16 01:11:08 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:11:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:08 2007 (delta -2) Okt 16 01:11:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:14 2007 (delta -2) Okt 16 01:11:19 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:11:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:20 2007 (delta -2) Okt 16 01:11:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:26 2007 (delta -2) Okt 16 01:11:29 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:11:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:32 2007 (delta -2) Okt 16 01:11:39 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:11:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:38 2007 (delta -2) Okt 16 01:11:45 [core.auStats] EMM packet load average (1/4/10min) 817 808 610 pks/s Okt 16 01:11:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:44 2007 (delta -2) Okt 16 01:11:49 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:11:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:50 2007 (delta -2) Okt 16 01:11:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:11:56 2007 (delta -2) Okt 16 01:11:59 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:12:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:02 2007 (delta -2) Okt 16 01:12:09 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:12:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:08 2007 (delta -2) Okt 16 01:12:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:14 2007 (delta -2) Okt 16 01:12:19 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:12:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:20 2007 (delta -2) Okt 16 01:12:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:26 2007 (delta -2) Okt 16 01:12:29 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:12:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:32 2007 (delta -2) Okt 16 01:12:39 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:12:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:38 2007 (delta -2) Okt 16 01:12:45 [core.auStats] EMM packet load average (1/4/10min) 833 816 693 pks/s Okt 16 01:12:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:44 2007 (delta -2) Okt 16 01:12:49 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:12:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:50 2007 (delta -2) Okt 16 01:12:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:12:56 2007 (delta -2) Okt 16 01:12:59 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:13:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:02 2007 (delta -2) Okt 16 01:13:09 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:13:09 [viaccess.tpsau] purging TPS keylist Okt 16 01:13:09 [viaccess.tps] 25 TPS keys available (from Okt 16 00:21:00 to Okt 16 05:09:00) Okt 16 01:13:09 [core.load] saved cache to file Okt 16 01:13:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:08 2007 (delta -2) Okt 16 01:13:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:14 2007 (delta -2) Okt 16 01:13:20 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:13:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:20 2007 (delta -2) Okt 16 01:13:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:26 2007 (delta -2) Okt 16 01:13:30 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:13:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:32 2007 (delta -2) Okt 16 01:13:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:38 2007 (delta -2) Okt 16 01:13:40 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:13:45 [core.auStats] EMM packet load average (1/4/10min) 756 814 769 pks/s Okt 16 01:13:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:44 2007 (delta -2) Okt 16 01:13:50 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:13:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:50 2007 (delta -2) Okt 16 01:13:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:13:56 2007 (delta -2) Okt 16 01:14:00 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:14:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:02 2007 (delta -2) Okt 16 01:14:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:08 2007 (delta -2) Okt 16 01:14:10 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:14:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:14 2007 (delta -2) Okt 16 01:14:20 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:14:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:20 2007 (delta -2) Okt 16 01:14:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:26 2007 (delta -2) Okt 16 01:14:31 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:14:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:32 2007 (delta -2) Okt 16 01:14:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:38 2007 (delta -2) Okt 16 01:14:41 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:14:45 [core.auStats] EMM packet load average (1/4/10min) 793 800 807 pks/s Okt 16 01:14:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:44 2007 (delta -2) Okt 16 01:14:51 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:14:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:50 2007 (delta -2) Okt 16 01:14:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:14:56 2007 (delta -2) Okt 16 01:15:01 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:15:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:02 2007 (delta -2) Okt 16 01:15:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:08 2007 (delta -2) Okt 16 01:15:11 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:15:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:14 2007 (delta -2) Okt 16 01:15:21 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:15:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:20 2007 (delta -2) Okt 16 01:15:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:26 2007 (delta -2) Okt 16 01:15:31 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:15:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:32 2007 (delta -2) Okt 16 01:15:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:38 2007 (delta -2) Okt 16 01:15:41 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:15:45 [core.auStats] EMM packet load average (1/4/10min) 811 798 808 pks/s Okt 16 01:15:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:44 2007 (delta -2) Okt 16 01:15:51 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:15:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:50 2007 (delta -2) Okt 16 01:15:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:15:56 2007 (delta -2) Okt 16 01:16:02 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:16:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:02 2007 (delta -2) Okt 16 01:16:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:08 2007 (delta -2) Okt 16 01:16:11 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:16:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:14 2007 (delta -2) Okt 16 01:16:22 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:16:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:20 2007 (delta -2) Okt 16 01:16:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:26 2007 (delta -2) Okt 16 01:16:31 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:16:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:32 2007 (delta -2) Okt 16 01:16:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:38 2007 (delta -2) Okt 16 01:16:42 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:16:45 [core.auStats] EMM packet load average (1/4/10min) 832 798 807 pks/s Okt 16 01:16:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:44 2007 (delta -2) Okt 16 01:16:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:50 2007 (delta -2) Okt 16 01:16:52 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:16:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:16:56 2007 (delta -2) Okt 16 01:17:02 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:17:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:02 2007 (delta -2) Okt 16 01:17:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:08 2007 (delta -2) Okt 16 01:17:12 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:17:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:14 2007 (delta -2) Okt 16 01:17:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:20 2007 (delta -2) Okt 16 01:17:22 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:17:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:26 2007 (delta -2) Okt 16 01:17:32 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:17:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:32 2007 (delta -2) Okt 16 01:17:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:38 2007 (delta -2) Okt 16 01:17:42 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:17:45 [core.auStats] EMM packet load average (1/4/10min) 808 811 807 pks/s Okt 16 01:17:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:44 2007 (delta -2) Okt 16 01:17:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:50 2007 (delta -2) Okt 16 01:17:53 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:17:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:17:56 2007 (delta -2) Okt 16 01:18:03 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:18:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:02 2007 (delta -2) Okt 16 01:18:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:08 2007 (delta -2) Okt 16 01:18:13 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:18:13 [viaccess.tpsau] purging TPS keylist Okt 16 01:18:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:14 2007 (delta -2) Okt 16 01:18:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:20 2007 (delta -2) Okt 16 01:18:23 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:18:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:26 2007 (delta -2) Okt 16 01:18:33 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:18:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:32 2007 (delta -2) Okt 16 01:18:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:38 2007 (delta -2) Okt 16 01:18:43 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:18:45 [core.auStats] EMM packet load average (1/4/10min) 839 823 810 pks/s Okt 16 01:18:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:44 2007 (delta -2) Okt 16 01:18:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:50 2007 (delta -2) Okt 16 01:18:54 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:18:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:18:56 2007 (delta -2) Okt 16 01:19:04 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:02 2007 (delta -2) Okt 16 01:19:04 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:19:10 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:08 2007 (delta -2) Okt 16 01:19:14 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:19:16 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:14 2007 (delta -2) Okt 16 01:19:22 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:20 2007 (delta -2) Okt 16 01:19:24 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:19:28 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:26 2007 (delta -2) Okt 16 01:19:34 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:32 2007 (delta -2) Okt 16 01:19:34 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:19:40 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:38 2007 (delta -2) Okt 16 01:19:44 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:19:45 [core.auStats] EMM packet load average (1/4/10min) 827 827 817 pks/s Okt 16 01:19:46 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:44 2007 (delta -2) Okt 16 01:19:52 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:50 2007 (delta -2) Okt 16 01:19:54 [core.pids] 0: now tuned to source 8882 transponder 33928 Okt 16 01:19:54 [core.ecm] 0.0: stop Okt 16 01:19:54 [core.au] 0: stopping chain 0500 Okt 16 01:19:54 [core.hook] 0: stopping hook 'sattime' (50001) Okt 16 01:19:54 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:19:54 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:19:54 [core.ecm] 0.0: triggered SID 1503/-1 idx 0/0 mode 3/-1 - Okt 16 01:19:54 [core.pids] 0: livepids video=00a4 audio=0000 Okt 16 01:19:54 [core.pids] 0: livepids video=00a4 audio=0060 Okt 16 01:19:54 [core.pids] 0: add SID 13855 (zero=1 noshift=0) Okt 16 01:19:54 [core.pids] 0: pids VIDEO=00a4 AUDIO=0060 Okt 16 01:19:54 [core.pids] 0: SID=13855 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:19:54 [core.pids] 0: found handler for SID 13855 (0.0 idle=1 idx=0) Okt 16 01:19:54 [core.ecm] 0.0: setting new SID 13855 Okt 16 01:19:54 [core.pids] 0.0: pids on entry Okt 16 01:19:54 [core.pids] 0.0: pids after delete Okt 16 01:19:54 [core.pids] 0: descrambling pid 00a4 on index 0 Okt 16 01:19:54 [core.pids] 0: descrambling pid 0060 on index 0 Okt 16 01:19:54 [core.pids] 0.0: pids after add VIDEO=00a4 AUDIO=0060 Okt 16 01:19:54 [core.ecm] 0.0: is no longer idle Okt 16 01:19:54 [core.pids] 0: livepids video=00a4 audio=0061 Okt 16 01:19:54 [core.ecm] 0.0: triggered SID -1/13855 idx 0/0 mode -1/0 - Okt 16 01:19:57 [core.pids] 0: add SID 1503 (zero=0 noshift=0) Okt 16 01:19:57 [core.pids] 0: SID=1503 zero=0 | sid=-/-/- zero=0/13855/0 idle=-/-/- Okt 16 01:19:57 [core.pids] 0: found handler for SID 1503 (0.1 idle=1 idx=1) Okt 16 01:19:57 [core.ecm] 0.1: setting new SID 1503 Okt 16 01:19:57 [core.pids] 0.1: pids on entry Okt 16 01:19:57 [core.pids] 0.1: pids after delete Okt 16 01:19:57 [core.pids] 0.1: pids after add Okt 16 01:19:57 [core.ecm] 0.1: is idle Okt 16 01:19:57 [core.pids] 0: now tuned to source 8882 transponder 337b8 Okt 16 01:19:57 [core.ecm] 0.0: stop Okt 16 01:19:57 [core.ecm] 0.1: stop Okt 16 01:19:57 [core.pids] 0: livepids video=00a4 audio=0000 Okt 16 01:19:57 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:19:57 [core.ecm] 0.0: triggered SID 13855/-1 idx 0/0 mode 1/-1 - Okt 16 01:19:57 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:19:57 [core.pids] 0: livepids video=0140 audio=014a Okt 16 01:19:57 [core.ecm] 0.1: triggered SID -1/-1 idx -1/1 mode -1/-1 - Okt 16 01:19:57 [core.pids] 0: add SID 1503 (zero=1 noshift=0) Okt 16 01:19:57 [core.pids] 0: pids VIDEO=0140 AUDIO=014a Okt 16 01:19:57 [core.pids] 0: SID=1503 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:19:57 [core.pids] 0: found handler for SID 1503 (0.0 idle=1 idx=0) Okt 16 01:19:57 [core.ecm] 0.0: setting new SID 1503 Okt 16 01:19:57 [core.pids] 0.0: pids on entry Okt 16 01:19:57 [core.pids] 0.0: pids after delete Okt 16 01:19:57 [core.pids] 0: descrambling pid 0140 on index 0 Okt 16 01:19:57 [core.pids] 0: descrambling pid 014a on index 0 Okt 16 01:19:57 [core.pids] 0.0: pids after add VIDEO=0140 AUDIO=014a Okt 16 01:19:57 [core.ecm] 0.0: is no longer idle Okt 16 01:19:57 [core.ecm] 0.0: triggered SID -1/1503 idx 0/0 mode -1/0 - Okt 16 01:19:57 [core.ecm] 0.0: got CaDescriptors for SID 1503 (len=138) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 05 00 e1 68 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:19:57 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 168 (new) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 05 00 e1 6a 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:19:57 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 16a (new) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 05 00 e1 6c 10 01 00 13 01 20 14 03 00 81 08 Okt 16 01:19:57 [core.ecm] 0.0: found 0500 (Viaccess) id 8100 with ecm 16c (new) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 05 00 e1 70 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:19:57 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 170 (new) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 05 00 e1 71 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:19:57 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 171 (new) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 05 00 e1 69 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:19:57 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 169 (new) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 05 00 e1 73 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:19:57 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 173 (new) Okt 16 01:19:57 [core.ecm] 0.0: descriptor 01 00 e1 6b 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:19:57 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 16b (new) Okt 16 01:19:57 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 168 (pri=-10) Okt 16 01:19:57 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:19:57 [core.hook] 0: starting hook 'sattime' (50001) Okt 16 01:19:57 [core.hook] 0: added filter pid=0x0014 sct=0x71/0xff/0x03 idle=15000 crc=0 Okt 16 01:19:57 [viaccess.time] added hook Okt 16 01:19:57 [core.ecm] system: no key found for V 7c00 08 Okt 16 01:19:57 [core.au] 0: chain caid 0500 -> Viaccess(-10) [0032-8b/fe/07] Okt 16 01:19:57 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] Okt 16 01:19:57 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] Okt 16 01:19:57 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] [0035-8b/fe/07] Okt 16 01:19:57 [core.au] 0: starting chain 0500 Okt 16 01:19:58 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 16a (pri=-10) Okt 16 01:19:58 [viaccess.time] 8882:337b8: Mon Oct 15 23:19:56 2007 (delta -2) Okt 16 01:19:58 [core.ecm] system: no key found for V 22600 08 Okt 16 01:19:58 [core.ecm] 0.0: try system Viaccess (0500) id 8100 with ecm 16c (pri=-10) Okt 16 01:19:58 [core.ecm] system: no key found for V 8100 08 Okt 16 01:19:58 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 170 (pri=-10) Okt 16 01:19:58 [core.ecm] system: no key found for V 20000 08 Okt 16 01:19:59 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 171 (pri=-10) Okt 16 01:19:59 [core.ecm] system: no key found for V 8300 08 Okt 16 01:19:59 [core.pids] 0: tune to same source/transponder Okt 16 01:19:59 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:19:59 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:19:59 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:19:59 [core.pids] 0: livepids video=0140 audio=014a Okt 16 01:19:59 [core.pids] 0: add SID 1513 (zero=0 noshift=0) Okt 16 01:19:59 [core.pids] 0: SID=1513 zero=0 | sid=-/-/- zero=0/1503/0 idle=1/-1/1 Okt 16 01:19:59 [core.pids] 0: found handler for SID 1513 (0.1 idle=1 idx=1) Okt 16 01:19:59 [core.ecm] 0.1: setting new SID 1513 Okt 16 01:19:59 [core.pids] 0.1: pids on entry Okt 16 01:19:59 [core.pids] 0.1: pids after delete Okt 16 01:19:59 [core.pids] 0.1: pids after add Okt 16 01:19:59 [core.ecm] 0.1: is idle Okt 16 01:19:59 [core.pids] 0: update SID 1503 (zero=1 noshift=0) Okt 16 01:19:59 [core.pids] 0: pids VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.pids] 0: SID=1503 zero=1 | sid=0/1503/0 zero=0/1503/0 idle=1/1513/1 Okt 16 01:19:59 [core.pids] 0: found handler for SID 1503 (0.0 idle=0 idx=0) Okt 16 01:19:59 [core.pids] 0.0: pids on entry VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.pids] 0.0: pids after delete VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.pids] 0.0: pids after add VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.ecm] 0.0: try system Viaccess (0500) id 22610 with ecm 169 (pri=-10) Okt 16 01:19:59 [core.ecm] 0.0: triggered SID 1503/1503 idx 0/0 mode 4/0 - Okt 16 01:19:59 [core.ecm] 0.1: triggered SID -1/1513 idx 1/1 mode -1/-1 - Okt 16 01:19:59 [core.ecm] system: no key found for V 22610 08 Okt 16 01:19:59 [core.ecm] 0.0: try system Viaccess (0500) id 20010 with ecm 173 (pri=-10) Okt 16 01:19:59 [core.pids] 0: tune to same source/transponder Okt 16 01:19:59 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:19:59 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:19:59 [core.ecm] system: no key found for V 20010 08 Okt 16 01:19:59 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:19:59 [core.pids] 0: livepids video=0140 audio=014a Okt 16 01:19:59 [core.pids] 0: add SID 1520 (zero=0 noshift=0) Okt 16 01:19:59 [core.pids] 0: SID=1520 zero=0 | sid=-/-/- zero=0/1503/0 idle=1/1513/1 Okt 16 01:19:59 [core.pids] 0: found handler for SID 1520 (0.1 idle=1 idx=1) Okt 16 01:19:59 [core.ecm] 0.1: setting new SID 1520 Okt 16 01:19:59 [core.pids] 0.1: pids on entry Okt 16 01:19:59 [core.pids] 0.1: pids after delete Okt 16 01:19:59 [core.pids] 0.1: pids after add Okt 16 01:19:59 [core.ecm] 0.1: is idle Okt 16 01:19:59 [core.pids] 0: update SID 1503 (zero=1 noshift=0) Okt 16 01:19:59 [core.pids] 0: pids VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.pids] 0: SID=1503 zero=1 | sid=0/1503/0 zero=0/1503/0 idle=1/1520/1 Okt 16 01:19:59 [core.pids] 0: found handler for SID 1503 (0.0 idle=0 idx=0) Okt 16 01:19:59 [core.pids] 0.0: pids on entry VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.pids] 0.0: pids after delete VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.pids] 0.0: pids after add VIDEO=0140 AUDIO=014a Okt 16 01:19:59 [core.ecm] 0.0: triggered SID 1503/1503 idx 0/0 mode 3/0 - Okt 16 01:19:59 [core.ecm] 0.1: triggered SID 1513/1520 idx 1/1 mode -1/-1 - Okt 16 01:19:59 [core.ecm] 0.0: try system Seca (0100) id 0084 with ecm 16b (pri=-10) Okt 16 01:19:59 [seca.ecm] Seca2 provider 0084 not supported Okt 16 01:20:00 [core.pids] 0: now tuned to source 8882 transponder 33d9b Okt 16 01:20:00 [core.ecm] 0.0: stop Okt 16 01:20:00 [core.ecm] 0.1: stop Okt 16 01:20:00 [core.au] 0: stopping chain 0500 Okt 16 01:20:00 [core.ecm] 0.1: triggered SID 1520/-1 idx 1/1 mode -1/-1 - Okt 16 01:20:00 [core.hook] 0: stopping hook 'sattime' (50001) Okt 16 01:20:00 [core.ecm] 0.0: got CaDescriptors for SID -1 (len=138) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 05 00 e1 68 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:20:00 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 168 (already present) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 05 00 e1 6a 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:20:00 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 16a (already present) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 05 00 e1 6c 10 01 00 13 01 20 14 03 00 81 08 Okt 16 01:20:00 [core.ecm] 0.0: found 0500 (Viaccess) id 8100 with ecm 16c (already present) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 05 00 e1 70 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:20:00 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 170 (already present) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 05 00 e1 71 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:20:00 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 171 (already present) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 05 00 e1 69 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:20:00 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 169 (already present) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 05 00 e1 73 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:20:00 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 173 (already present) Okt 16 01:20:00 [core.ecm] 0.0: descriptor 01 00 e1 6b 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:20:00 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 16b (already present) Okt 16 01:20:00 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:20:00 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 168 (pri=-10) Okt 16 01:20:00 [core.ecm] 0.0: triggered SID 1503/-1 idx 0/0 mode 4/-1 - Okt 16 01:20:00 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:00 [core.pids] 0: livepids video=0cf9 audio=0000 Okt 16 01:20:00 [core.pids] 0: livepids video=0cf9 audio=0d03 Okt 16 01:20:00 [core.pids] 0: add SID 3051 (zero=1 noshift=0) Okt 16 01:20:00 [core.pids] 0: pids VIDEO=0cf9 AUDIO=0d03 Okt 16 01:20:00 [core.pids] 0: SID=3051 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:20:00 [core.pids] 0: found handler for SID 3051 (0.0 idle=1 idx=0) Okt 16 01:20:00 [core.ecm] 0.0: setting new SID 3051 Okt 16 01:20:00 [core.pids] 0.0: pids on entry Okt 16 01:20:00 [core.pids] 0.0: pids after delete Okt 16 01:20:00 [core.pids] 0: descrambling pid 0cf9 on index 0 Okt 16 01:20:00 [core.pids] 0: descrambling pid 0d03 on index 0 Okt 16 01:20:00 [core.pids] 0.0: pids after add VIDEO=0cf9 AUDIO=0d03 Okt 16 01:20:00 [core.ecm] 0.0: is no longer idle Okt 16 01:20:00 [core.pids] 0: livepids video=0cf9 audio=0d17 Okt 16 01:20:00 [core.au] 0: chain caid 0500 -> Viaccess(-10) [0032-8b/fe/07] Okt 16 01:20:00 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] Okt 16 01:20:00 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] Okt 16 01:20:00 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] [0035-8b/fe/07] Okt 16 01:20:00 [core.ecm] 0.0: triggered SID -1/3051 idx 0/0 mode -1/0 - Okt 16 01:20:00 [core.au] 0: chain caid 0100 -> Seca(-10) [0e74-82/ff/00] [0e75-84/ff/00] Okt 16 01:20:00 [core.pids] 0: tune to same source/transponder Okt 16 01:20:00 [core.pids] 0: livepids video=0cf9 audio=0000 Okt 16 01:20:00 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:00 [core.pids] 0: livepids video=0141 audio=0000 Okt 16 01:20:00 [core.pids] 0: update SID 3051 (zero=0 noshift=0) Okt 16 01:20:00 [core.pids] 0: pids AUDIO=0d03 Okt 16 01:20:00 [core.pids] 0: SID=3051 zero=0 | sid=0/3051/0 zero=0/3051/0 idle=1/-1/1 Okt 16 01:20:00 [core.ecm] 0: shifting cwindex on non-idle handler. Okt 16 01:20:00 [core.pids] 0.0: shifting cwIndex from 0 to 2 Okt 16 01:20:00 [core.pids] 0: descrambling pid 0cf9 on index 2 Okt 16 01:20:00 [core.pids] 0: descrambling pid 0d03 on index 2 Okt 16 01:20:00 [core.pids] 0: found handler for SID 3051 (0.2 idle=0 idx=2) Okt 16 01:20:00 [core.pids] 0.2: pids on entry VIDEO=0cf9 AUDIO=0d03 Okt 16 01:20:00 [core.pids] 0.2: pids after delete AUDIO=0d03 Okt 16 01:20:00 [core.pids] 0.2: pids after add AUDIO=0d03 Okt 16 01:20:00 [core.pids] 0: add SID 3052 (zero=1 noshift=0) Okt 16 01:20:00 [core.pids] 0: pids VIDEO=0141 Okt 16 01:20:00 [core.pids] 0: SID=3052 zero=1 | sid=-/-/- zero=-/-/- idle=1/-1/1 Okt 16 01:20:00 [core.pids] 0.1: shifting cwIndex from 1 to 0 Okt 16 01:20:00 [core.pids] 0: found handler for SID 3052 (0.0 idle=1 idx=0) Okt 16 01:20:00 [core.ecm] 0.0: setting new SID 3052 Okt 16 01:20:00 [core.pids] 0.0: pids on entry Okt 16 01:20:00 [core.pids] 0.0: pids after delete Okt 16 01:20:00 [core.pids] 0: descrambling pid 0141 on index 0 Okt 16 01:20:00 [core.pids] 0.0: pids after add VIDEO=0141 Okt 16 01:20:00 [core.ecm] 0.0: is no longer idle Okt 16 01:20:00 [core.ecm] 0.0: triggered SID -1/3052 idx 1/0 mode -1/0 - Okt 16 01:20:00 [core.ecm] 0.2: triggered SID 3051/3051 idx 0/2 mode 1/0 - Okt 16 01:20:01 [core.pids] 0: now tuned to source 8882 transponder 1b441 Okt 16 01:20:01 [core.ecm] 0.2: stop Okt 16 01:20:01 [core.ecm] 0.0: stop Okt 16 01:20:01 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:01 [core.ecm] 0.0: triggered SID 3052/-1 idx 0/0 mode 1/-1 - Okt 16 01:20:01 [core.ecm] 0.2: triggered SID 3051/-1 idx 2/2 mode 1/-1 - Okt 16 01:20:01 [core.pids] 0: livepids video=00a7 audio=0000 Okt 16 01:20:01 [core.pids] 0: livepids video=00a7 audio=006c Okt 16 01:20:01 [core.pids] 0: add SID 208 (zero=1 noshift=0) Okt 16 01:20:01 [core.pids] 0: pids VIDEO=00a7 AUDIO=006c Okt 16 01:20:01 [core.pids] 0: SID=208 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:20:01 [core.pids] 0: found handler for SID 208 (0.0 idle=1 idx=0) Okt 16 01:20:01 [core.ecm] 0.0: setting new SID 208 Okt 16 01:20:01 [core.pids] 0.0: pids on entry Okt 16 01:20:01 [core.pids] 0.0: pids after delete Okt 16 01:20:01 [core.pids] 0: descrambling pid 00a7 on index 0 Okt 16 01:20:01 [core.pids] 0: descrambling pid 006c on index 0 Okt 16 01:20:01 [core.pids] 0.0: pids after add VIDEO=00a7 AUDIO=006c Okt 16 01:20:01 [core.ecm] 0.0: is no longer idle Okt 16 01:20:01 [core.ecm] 0.0: triggered SID -1/208 idx 0/0 mode -1/0 - Okt 16 01:20:02 [core.pids] 0: add SID 1120 (zero=0 noshift=0) Okt 16 01:20:02 [core.pids] 0: SID=1120 zero=0 | sid=-/-/- zero=0/208/0 idle=2/-1/1 Okt 16 01:20:02 [core.pids] 0: found handler for SID 1120 (0.2 idle=1 idx=2) Okt 16 01:20:02 [core.ecm] 0.2: setting new SID 1120 Okt 16 01:20:02 [core.pids] 0.2: pids on entry Okt 16 01:20:02 [core.pids] 0.2: pids after delete Okt 16 01:20:02 [core.pids] 0.2: pids after add Okt 16 01:20:02 [core.ecm] 0.2: is idle Okt 16 01:20:02 [core.ecm] 0.2: triggered SID -1/1120 idx 2/2 mode -1/-1 - Okt 16 01:20:02 [core.pids] 0: now tuned to source 8882 transponder 33792 Okt 16 01:20:02 [core.ecm] 0.2: stop Okt 16 01:20:02 [core.ecm] 0.0: stop Okt 16 01:20:02 [core.pids] 0: livepids video=00a7 audio=0000 Okt 16 01:20:02 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:02 [core.ecm] 0.0: triggered SID 208/-1 idx 0/0 mode 1/-1 - Okt 16 01:20:02 [core.ecm] 0.2: triggered SID 1120/-1 idx 2/2 mode -1/-1 - Okt 16 01:20:02 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:20:02 [core.pids] 0: livepids video=0140 audio=014a Okt 16 01:20:02 [core.pids] 0: add SID 1120 (zero=1 noshift=0) Okt 16 01:20:02 [core.pids] 0: pids VIDEO=0140 AUDIO=014a Okt 16 01:20:02 [core.pids] 0: SID=1120 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:20:02 [core.pids] 0: found handler for SID 1120 (0.0 idle=1 idx=0) Okt 16 01:20:02 [core.ecm] 0.0: setting new SID 1120 Okt 16 01:20:02 [core.pids] 0.0: pids on entry Okt 16 01:20:02 [core.pids] 0.0: pids after delete Okt 16 01:20:02 [core.pids] 0: descrambling pid 0140 on index 0 Okt 16 01:20:02 [core.pids] 0: descrambling pid 014a on index 0 Okt 16 01:20:02 [core.pids] 0.0: pids after add VIDEO=0140 AUDIO=014a Okt 16 01:20:02 [core.ecm] 0.0: is no longer idle Okt 16 01:20:02 [core.ecm] 0.0: triggered SID -1/1120 idx 0/0 mode -1/0 - Okt 16 01:20:03 [core.pids] 0: add SID 503 (zero=0 noshift=0) Okt 16 01:20:03 [core.pids] 0: SID=503 zero=0 | sid=-/-/- zero=0/1120/0 idle=2/-1/1 Okt 16 01:20:03 [core.pids] 0: found handler for SID 503 (0.2 idle=1 idx=2) Okt 16 01:20:03 [core.ecm] 0.2: setting new SID 503 Okt 16 01:20:03 [core.pids] 0.2: pids on entry Okt 16 01:20:03 [core.pids] 0.2: pids after delete Okt 16 01:20:03 [core.pids] 0.2: pids after add Okt 16 01:20:03 [core.ecm] 0.2: is idle Okt 16 01:20:03 [core.pids] 0: now tuned to source 8882 transponder 1b834 Okt 16 01:20:03 [core.ecm] 0.2: stop Okt 16 01:20:03 [core.ecm] 0.0: stop Okt 16 01:20:03 [core.pids] 0: livepids video=0140 audio=0000 Okt 16 01:20:03 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:03 [core.ecm] 0.0: triggered SID 1120/-1 idx 0/0 mode 1/-1 - Okt 16 01:20:03 [core.ecm] 0.2: triggered SID -1/-1 idx 2/2 mode -1/-1 - Okt 16 01:20:03 [core.pids] 0: livepids video=00a2 audio=0000 Okt 16 01:20:03 [core.pids] 0: livepids video=00a2 audio=0058 Okt 16 01:20:03 [core.pids] 0: add SID 503 (zero=1 noshift=0) Okt 16 01:20:03 [core.pids] 0: pids VIDEO=00a2 AUDIO=0058 Okt 16 01:20:03 [core.pids] 0: SID=503 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:20:03 [core.pids] 0: found handler for SID 503 (0.0 idle=1 idx=0) Okt 16 01:20:03 [core.ecm] 0.0: setting new SID 503 Okt 16 01:20:03 [core.pids] 0.0: pids on entry Okt 16 01:20:03 [core.pids] 0.0: pids after delete Okt 16 01:20:03 [core.pids] 0: descrambling pid 00a2 on index 0 Okt 16 01:20:03 [core.pids] 0: descrambling pid 0058 on index 0 Okt 16 01:20:03 [core.pids] 0.0: pids after add VIDEO=00a2 AUDIO=0058 Okt 16 01:20:03 [core.ecm] 0.0: is no longer idle Okt 16 01:20:03 [core.ecm] 0.0: triggered SID -1/503 idx 0/0 mode -1/0 - Okt 16 01:20:04 [core.pids] 0: now tuned to source 8882 transponder 33792 Okt 16 01:20:04 [core.ecm] 0.0: stop Okt 16 01:20:04 [core.pids] 0: livepids video=00a2 audio=0000 Okt 16 01:20:04 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:04 [core.ecm] 0.0: triggered SID 503/-1 idx 0/0 mode 1/-1 - Okt 16 01:20:04 [core.pids] 0: livepids video=0208 audio=0000 Okt 16 01:20:04 [core.pids] 0: livepids video=0208 audio=0212 Okt 16 01:20:04 [core.pids] 0: add SID 1121 (zero=1 noshift=0) Okt 16 01:20:04 [core.pids] 0: pids VIDEO=0208 AUDIO=0212 Okt 16 01:20:04 [core.pids] 0: SID=1121 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:20:04 [core.pids] 0: found handler for SID 1121 (0.0 idle=1 idx=0) Okt 16 01:20:04 [core.ecm] 0.0: setting new SID 1121 Okt 16 01:20:04 [core.pids] 0.0: pids on entry Okt 16 01:20:04 [core.pids] 0.0: pids after delete Okt 16 01:20:04 [core.pids] 0: descrambling pid 0208 on index 0 Okt 16 01:20:04 [core.pids] 0: descrambling pid 0212 on index 0 Okt 16 01:20:04 [core.pids] 0.0: pids after add VIDEO=0208 AUDIO=0212 Okt 16 01:20:04 [core.ecm] 0.0: is no longer idle Okt 16 01:20:04 [core.ecm] 0.0: triggered SID -1/1121 idx 0/0 mode -1/0 - Okt 16 01:20:04 [core.pids] 0: now tuned to source 8882 transponder 337b8 Okt 16 01:20:04 [core.ecm] 0.0: stop Okt 16 01:20:04 [core.pids] 0: livepids video=0208 audio=0000 Okt 16 01:20:04 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:04 [core.ecm] 0.0: triggered SID 1121/-1 idx 0/0 mode 1/-1 - Okt 16 01:20:04 [core.pids] 0: livepids video=0208 audio=0000 Okt 16 01:20:04 [core.pids] 0: livepids video=0208 audio=0212 Okt 16 01:20:05 [core.pids] 0: add SID 1505 (zero=1 noshift=0) Okt 16 01:20:05 [core.pids] 0: pids VIDEO=0208 AUDIO=0212 Okt 16 01:20:05 [core.pids] 0: SID=1505 zero=1 | sid=-/-/- zero=0/-1/1 idle=0/-1/1 Okt 16 01:20:05 [core.pids] 0: found handler for SID 1505 (0.0 idle=1 idx=0) Okt 16 01:20:05 [core.ecm] 0.0: setting new SID 1505 Okt 16 01:20:05 [core.pids] 0.0: pids on entry Okt 16 01:20:05 [core.pids] 0.0: pids after delete Okt 16 01:20:05 [core.pids] 0: descrambling pid 0208 on index 0 Okt 16 01:20:05 [core.pids] 0: descrambling pid 0212 on index 0 Okt 16 01:20:05 [core.pids] 0.0: pids after add VIDEO=0208 AUDIO=0212 Okt 16 01:20:05 [core.ecm] 0.0: is no longer idle Okt 16 01:20:05 [core.ecm] 0.0: triggered SID -1/1505 idx 0/0 mode -1/0 - Okt 16 01:20:05 [core.ecm] 0.0: got CaDescriptors for SID 1505 (len=153) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 05 00 e2 30 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:20:05 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 230 (new) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 05 00 e2 32 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:20:05 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 232 (new) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 05 00 e2 38 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:20:05 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 238 (new) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 05 00 e2 34 10 01 00 13 01 20 14 03 00 81 08 Okt 16 01:20:05 [core.ecm] 0.0: found 0500 (Viaccess) id 8100 with ecm 234 (new) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 05 00 e2 39 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:20:05 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 239 (new) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 05 00 e2 31 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:20:05 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 231 (new) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 05 00 e2 3b 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:20:05 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 23b (new) Okt 16 01:20:05 [core.ecm] 0.0: descriptor 01 00 e2 33 00 84 ff 40 20 01 20 21 10 04 4c 00 21 e2 3a 00 85 ff 00 00 00 00 00 00 10 02 00 21 Okt 16 01:20:05 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 233 (new) Okt 16 01:20:05 [core.ecm] 0.0: found 0100 (Seca) id 0085 with ecm 23a (new) Okt 16 01:20:05 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 230 (pri=-10) Okt 16 01:20:05 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:20:05 [core.hook] 0: starting hook 'sattime' (50001) Okt 16 01:20:05 [core.hook] 0: added filter pid=0x0014 sct=0x71/0xff/0x03 idle=15000 crc=0 Okt 16 01:20:05 [viaccess.time] added hook Okt 16 01:20:05 [core.ecm] system: no key found for V 7c00 08 Okt 16 01:20:05 [core.pids] 0: tune to same source/transponder Okt 16 01:20:05 [core.pids] 0: livepids video=0208 audio=0000 Okt 16 01:20:05 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:05 [core.pids] 0: livepids video=0208 audio=0000 Okt 16 01:20:05 [core.pids] 0: livepids video=0208 audio=0212 Okt 16 01:20:05 [core.pids] 0: add SID 1523 (zero=0 noshift=0) Okt 16 01:20:05 [core.pids] 0: SID=1523 zero=0 | sid=-/-/- zero=0/1505/0 idle=2/-1/1 Okt 16 01:20:05 [core.pids] 0: found handler for SID 1523 (0.2 idle=1 idx=2) Okt 16 01:20:05 [core.ecm] 0.2: setting new SID 1523 Okt 16 01:20:05 [core.pids] 0.2: pids on entry Okt 16 01:20:05 [core.pids] 0.2: pids after delete Okt 16 01:20:05 [core.pids] 0.2: pids after add Okt 16 01:20:05 [core.ecm] 0.2: is idle Okt 16 01:20:05 [core.pids] 0: update SID 1505 (zero=1 noshift=0) Okt 16 01:20:05 [core.pids] 0: pids VIDEO=0208 AUDIO=0212 Okt 16 01:20:05 [core.pids] 0: SID=1505 zero=1 | sid=0/1505/0 zero=0/1505/0 idle=2/1523/1 Okt 16 01:20:05 [core.pids] 0: found handler for SID 1505 (0.0 idle=0 idx=0) Okt 16 01:20:05 [core.pids] 0.0: pids on entry VIDEO=0208 AUDIO=0212 Okt 16 01:20:05 [core.pids] 0.0: pids after delete VIDEO=0208 AUDIO=0212 Okt 16 01:20:05 [core.pids] 0.0: pids after add VIDEO=0208 AUDIO=0212 Okt 16 01:20:05 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 232 (pri=-10) Okt 16 01:20:05 [core.ecm] 0.0: triggered SID 1505/1505 idx 0/0 mode 4/0 - Okt 16 01:20:05 [core.au] 0: chain caid 0500 -> Viaccess(-10) [0032-8b/fe/07] Okt 16 01:20:05 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] Okt 16 01:20:05 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] Okt 16 01:20:05 [core.au] 0: chain caid 0500 ++ [0032-8b/fe/07] [0033-8b/fe/07] [0034-8b/fe/07] [0035-8b/fe/07] Okt 16 01:20:05 [core.au] 0: starting chain 0500 Okt 16 01:20:05 [core.ecm] 0.2: triggered SID -1/1523 idx 2/2 mode -1/-1 - Okt 16 01:20:05 [core.ecm] system: no key found for V 22600 08 Okt 16 01:20:05 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 238 (pri=-10) Okt 16 01:20:05 [core.ecm] system: no key found for V 20000 08 Okt 16 01:20:06 [core.ecm] 0.0: try system Viaccess (0500) id 8100 with ecm 234 (pri=-10) Okt 16 01:20:06 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:04 2007 (delta -2) Okt 16 01:20:06 [core.ecm] system: no key found for V 8100 08 Okt 16 01:20:06 [core.pids] 0: tune to same source/transponder Okt 16 01:20:06 [core.pids] 0: livepids video=0208 audio=0000 Okt 16 01:20:06 [core.pids] 0: livepids video=0000 audio=0000 Okt 16 01:20:06 [core.pids] 0: livepids video=0334 audio=0000 Okt 16 01:20:06 [core.pids] 0: livepids video=0334 audio=033e Okt 16 01:20:06 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 239 (pri=-10) Okt 16 01:20:06 [core.pids] 0: update SID 1505 (zero=0 noshift=1) Okt 16 01:20:06 [core.pids] 0: SID=1505 zero=0 | sid=0/1505/0 zero=0/1505/0 idle=2/1523/1 Okt 16 01:20:06 [core.pids] 0: found handler for SID 1505 (0.0 idle=0 idx=0) Okt 16 01:20:06 [core.pids] 0.0: pids on entry VIDEO=0208 AUDIO=0212 Okt 16 01:20:06 [core.pids] 0.0: pids after delete Okt 16 01:20:06 [core.pids] 0.0: pids after add Okt 16 01:20:06 [core.ecm] 0.0: is idle now Okt 16 01:20:06 [core.pids] 0: add SID 1508 (zero=1 noshift=0) Okt 16 01:20:06 [core.pids] 0: pids VIDEO=0334 AUDIO=033e Okt 16 01:20:06 [core.pids] 0: SID=1508 zero=1 | sid=-/-/- zero=0/1505/1 idle=0/1505/1 Okt 16 01:20:06 [core.pids] 0: found handler for SID 1508 (0.0 idle=1 idx=0) Okt 16 01:20:06 [core.ecm] 0.0: setting new SID 1508 Okt 16 01:20:06 [core.pids] 0.0: pids on entry Okt 16 01:20:06 [core.pids] 0.0: pids after delete Okt 16 01:20:06 [core.pids] 0: descrambling pid 0334 on index 0 Okt 16 01:20:06 [core.pids] 0: descrambling pid 033e on index 0 Okt 16 01:20:06 [core.pids] 0.0: pids after add VIDEO=0334 AUDIO=033e Okt 16 01:20:06 [core.ecm] 0.0: is no longer idle Okt 16 01:20:06 [core.ecm] 0.0: triggered SID 1505/1508 idx 0/0 mode 4/0 - Okt 16 01:20:06 [core.ecm] 0.0: got CaDescriptors for SID 1508 (len=121) Okt 16 01:20:06 [core.ecm] 0.0: descriptor 05 00 e3 5c 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:20:06 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 35c (new) Okt 16 01:20:06 [core.ecm] 0.0: descriptor 05 00 e3 5d 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:20:06 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 35d (new) Okt 16 01:20:06 [core.ecm] 0.0: descriptor 05 00 e3 5e 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:20:06 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 35e (new) Okt 16 01:20:06 [core.ecm] 0.0: descriptor 05 00 e3 64 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:20:06 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 364 (new) Okt 16 01:20:06 [core.ecm] 0.0: descriptor 05 00 e3 65 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:20:06 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 365 (new) Okt 16 01:20:06 [core.ecm] 0.0: descriptor 05 00 e3 67 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:20:06 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 367 (new) Okt 16 01:20:06 [core.ecm] 0.0: descriptor 01 00 e3 5f 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:20:06 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 35f (new) Okt 16 01:20:06 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 35c (pri=-10) Okt 16 01:20:06 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:20:06 [core.ecm] system: no key found for V 7c00 08 Okt 16 01:20:06 [core.ecm] 0.0: try system Viaccess (0500) id 22610 with ecm 35d (pri=-10) Okt 16 01:20:06 [core.ecm] system: no key found for V 22610 08 Okt 16 01:20:07 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 35e (pri=-10) Okt 16 01:20:07 [core.ecm] system: no key found for V 22600 08 Okt 16 01:20:07 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 364 (pri=-10) Okt 16 01:20:07 [core.ecm] system: no key found for V 20000 08 Okt 16 01:20:07 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 365 (pri=-10) Okt 16 01:20:07 [core.ecm] system: no key found for V 8300 08 Okt 16 01:20:08 [core.ecm] 0.0: try system Viaccess (0500) id 20010 with ecm 367 (pri=-10) Okt 16 01:20:08 [core.ecm] system: no key found for V 20010 08 Okt 16 01:20:08 [core.ecm] 0.0: try system Seca (0100) id 0084 with ecm 35f (pri=-10) Okt 16 01:20:08 [seca.ecm] Seca2 provider 0084 not supported Okt 16 01:20:08 [core.ecm] 0.0: got CaDescriptors for SID 1508 (len=121) Okt 16 01:20:08 [core.ecm] 0.0: descriptor 05 00 e3 5c 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:20:08 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 35c (already present) Okt 16 01:20:08 [core.ecm] 0.0: descriptor 05 00 e3 5d 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:20:08 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 35d (already present) Okt 16 01:20:08 [core.ecm] 0.0: descriptor 05 00 e3 5e 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:20:08 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 35e (already present) Okt 16 01:20:08 [core.ecm] 0.0: descriptor 05 00 e3 64 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:20:08 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 364 (already present) Okt 16 01:20:08 [core.ecm] 0.0: descriptor 05 00 e3 65 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:20:08 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 365 (already present) Okt 16 01:20:08 [core.ecm] 0.0: descriptor 05 00 e3 67 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:20:08 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 367 (already present) Okt 16 01:20:08 [core.ecm] 0.0: descriptor 01 00 e3 5f 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:20:08 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 35f (already present) Okt 16 01:20:08 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 35c (pri=-10) Okt 16 01:20:08 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:20:08 [core.ecm] system: no key found for V 7c00 08 Okt 16 01:20:09 [core.ecm] 0.0: try system Viaccess (0500) id 22610 with ecm 35d (pri=-10) Okt 16 01:20:09 [core.ecm] system: no key found for V 22610 08 Okt 16 01:20:09 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 35e (pri=-10) Okt 16 01:20:09 [core.ecm] system: no key found for V 22600 08 Okt 16 01:20:09 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 364 (pri=-10) Okt 16 01:20:09 [core.ecm] system: no key found for V 20000 08 Okt 16 01:20:10 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 365 (pri=-10) Okt 16 01:20:10 [core.ecm] system: no key found for V 8300 08 Okt 16 01:20:10 [core.ecm] 0.0: try system Viaccess (0500) id 20010 with ecm 367 (pri=-10) Okt 16 01:20:10 [core.ecm] system: no key found for V 20010 08 Okt 16 01:20:10 [core.ecm] 0.0: try system Seca (0100) id 0084 with ecm 35f (pri=-10) Okt 16 01:20:10 [seca.ecm] Seca2 provider 0084 not supported Okt 16 01:20:10 [core.ecm] 0.0: got CaDescriptors for SID 1508 (len=121) Okt 16 01:20:10 [core.ecm] 0.0: descriptor 05 00 e3 5c 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:20:10 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 35c (already present) Okt 16 01:20:10 [core.ecm] 0.0: descriptor 05 00 e3 5d 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:20:10 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 35d (already present) Okt 16 01:20:10 [core.ecm] 0.0: descriptor 05 00 e3 5e 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:20:10 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 35e (already present) Okt 16 01:20:10 [core.ecm] 0.0: descriptor 05 00 e3 64 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:20:10 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 364 (already present) Okt 16 01:20:10 [core.ecm] 0.0: descriptor 05 00 e3 65 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:20:10 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 365 (already present) Okt 16 01:20:10 [core.ecm] 0.0: descriptor 05 00 e3 67 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:20:10 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 367 (already present) Okt 16 01:20:10 [core.ecm] 0.0: descriptor 01 00 e3 5f 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:20:10 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 35f (already present) Okt 16 01:20:10 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 35c (pri=-10) Okt 16 01:20:12 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:10 2007 (delta -2) Okt 16 01:20:15 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:20:15 [core.ecm] system: no key found for V 7c00 08 Okt 16 01:20:15 [core.ecm] 0.0: try system Viaccess (0500) id 22610 with ecm 35d (pri=-10) Okt 16 01:20:15 [core.ecm] system: no key found for V 22610 08 Okt 16 01:20:15 [core.ecm] 0.0: try system Viaccess (0500) id 22600 with ecm 35e (pri=-10) Okt 16 01:20:15 [core.ecm] system: no key found for V 22600 08 Okt 16 01:20:16 [core.ecm] 0.0: try system Viaccess (0500) id 20000 with ecm 364 (pri=-10) Okt 16 01:20:16 [core.ecm] system: no key found for V 20000 08 Okt 16 01:20:16 [core.ecm] 0.0: try system Viaccess (0500) id 8300 with ecm 365 (pri=-10) Okt 16 01:20:16 [core.ecm] system: no key found for V 8300 08 Okt 16 01:20:16 [core.ecm] 0.0: try system Viaccess (0500) id 20010 with ecm 367 (pri=-10) Okt 16 01:20:16 [core.ecm] system: no key found for V 20010 08 Okt 16 01:20:17 [core.ecm] 0.0: try system Seca (0100) id 0084 with ecm 35f (pri=-10) Okt 16 01:20:17 [seca.ecm] Seca2 provider 0084 not supported Okt 16 01:20:17 [core.ecm] 0.0: got CaDescriptors for SID 1508 (len=121) Okt 16 01:20:17 [core.ecm] 0.0: descriptor 05 00 e3 5c 10 01 00 13 01 20 14 03 00 7c 08 Okt 16 01:20:17 [core.ecm] 0.0: found 0500 (Viaccess) id 7c00 with ecm 35c (already present) Okt 16 01:20:17 [core.ecm] 0.0: descriptor 05 00 e3 5d 10 01 00 13 01 20 14 03 02 26 18 Okt 16 01:20:17 [core.ecm] 0.0: found 0500 (Viaccess) id 22610 with ecm 35d (already present) Okt 16 01:20:17 [core.ecm] 0.0: descriptor 05 00 e3 5e 10 01 00 13 01 20 14 03 02 26 08 Okt 16 01:20:17 [core.ecm] 0.0: found 0500 (Viaccess) id 22600 with ecm 35e (already present) Okt 16 01:20:17 [core.ecm] 0.0: descriptor 05 00 e3 64 10 01 00 13 01 20 14 03 02 00 08 Okt 16 01:20:17 [core.ecm] 0.0: found 0500 (Viaccess) id 20000 with ecm 364 (already present) Okt 16 01:20:17 [core.ecm] 0.0: descriptor 05 00 e3 65 10 01 00 13 01 20 14 03 00 83 08 Okt 16 01:20:17 [core.ecm] 0.0: found 0500 (Viaccess) id 8300 with ecm 365 (already present) Okt 16 01:20:17 [core.ecm] 0.0: descriptor 05 00 e3 67 10 01 00 13 01 20 14 03 02 00 18 Okt 16 01:20:17 [core.ecm] 0.0: found 0500 (Viaccess) id 20010 with ecm 367 (already present) Okt 16 01:20:17 [core.ecm] 0.0: descriptor 01 00 e3 5f 00 84 ff 00 00 00 00 00 00 00 4c 00 21 Okt 16 01:20:17 [core.ecm] 0.0: found 0100 (Seca) id 0084 with ecm 35f (already present) Okt 16 01:20:17 [core.ecm] 0.0: try system Viaccess (0500) id 7c00 with ecm 35c (pri=-10) Okt 16 01:20:17 [core.ecm] 0.0: stopping message log until valid key is found Okt 16 01:20:18 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:16 2007 (delta -2) Okt 16 01:20:24 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:22 2007 (delta -2) Okt 16 01:20:25 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:20:30 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:28 2007 (delta -2) Okt 16 01:20:35 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:20:36 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:34 2007 (delta -2) Okt 16 01:20:42 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:40 2007 (delta -2) Okt 16 01:20:45 [core.auStats] EMM packet load average (1/4/10min) 708 795 802 pks/s Okt 16 01:20:45 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:20:48 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:46 2007 (delta -2) Okt 16 01:20:54 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:52 2007 (delta -2) Okt 16 01:20:55 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:21:00 [viaccess.time] 8882:337b8: Mon Oct 15 23:20:58 2007 (delta -2) Okt 16 01:21:05 [viaccess.time] 8882:337b8: using existing transpondertime Okt 16 01:21:06 [viaccess.time] 8882:337b8: Mon Oct 15 23:21:04 2007 (delta -2) Okt 16 01:21:12 [viaccess.time] 8882:337b8: Mon Oct 15 23:21:10 2007 (delta -2)