﻿23:12:09.354 - Start logging...
23:12:09.495 - ExceptionFilter::Init. restart=1
23:12:10.088 - DevicesManager::EnableCISupport
23:12:10.088 - CAVManager::SetSettings
23:12:10.104 - DevicesManager::DestroyAllTransponderManager
23:12:10.265 - SetDefaultNullCodecs
23:12:10.312 - IsWin8WithoutMpeg2Codecs 0
23:12:10.312 - IsWin8WithoutMpeg2Codecs 1
23:12:10.327 - IsWin8WithoutMpeg2Codecs 3
23:12:10.390 - SetDefaultNullCodecs
23:12:10.421 - IsWin8WithoutMpeg2Codecs 0
23:12:10.421 - IsWin8WithoutMpeg2Codecs 1
23:12:10.437 - IsWin8WithoutMpeg2Codecs 3
23:12:10.497 - DevicesManager::Start
23:12:10.497 - AVManager::Init
23:12:10.512 - RemoveAllCreateBlank needBlank1
23:12:10.528 - [101]OnChangeCurrentGraph2 -RemoveAllBlank
23:12:10.601 - VR: GUI
23:12:10.664 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
23:12:10.851 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
23:12:10.851 - AV:UpdateAudioParamsAfterActive
23:12:10.867 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
23:12:10.883 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
23:12:11.429 - DevicesManager::StartDevices...
23:12:11.445 - device netclient.0 23:12:11.461 - dev: Created  netclient.0 00000208A62CB8F0
OK
23:12:11.523 - Api2BaseModule.GetAdditionInfo
23:12:16.288 - 
23:12:16.304 - 
23:12:16.320 - ########################### Mark of start channel changing.###########################
23:12:16.335 - 
23:12:16.351 - GraphManager::MainChangeChannel DW  1 provs
23:12:16.367 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
23:12:16.382 - SetChannelLogic::SetChannel 0
23:12:16.398 - SetChannelLogic::SetNormalChannel
23:12:16.413 - DevicesManager::CreateCloneDevice
23:12:16.429 - DevicesManager::CreateCloneDevice OK - founded in list
23:12:16.445 - TransponderManager
23:12:16.460 - CTransponderManager::InitOnNewDevice 00000208A6312708
23:12:16.476 - SetOwner N -> Incoming Stream Cache
23:12:16.491 - TrafficProcessingScheme_CreateForNewEngineTransport 1 ss=0
23:12:16.507 - Normal TsInputTrafficProcessor.
23:12:16.523 - FilterManager::InitOnNewDevice 1
23:12:16.538 - TS router+MarkerFinder -> InputTrafficProcessor
23:12:16.554 - Incoming Stream Cache -> TS router+MarkerFinder
23:12:16.570 - InputTrafficProcessor -> Router to timeshift
23:12:16.585 - InputTrafficProcessor(FM) -> FilterManager
23:12:16.601 - ModuleList::Free
23:12:16.616 - Api2BaseModule::GetCurrentDeviceInfo
23:12:16.616 - ModuleList::Load C:\Program Files\ProgDVB x64 Professional\Modules\PidRecorder.module OK
23:12:16.632 - ChannelGraph5.CChannelGraph5
23:12:16.648 - TransponderManager::AddChildChannel
23:12:16.663 - TimeShift.TimeShift
23:12:16.695 - TimeShift.Create 200 mbytes 
23:12:16.710 - ts:One channel
23:12:16.726 - HugeMemoryBlocksManager::GetBlock 200 mbytes OK
23:12:16.726 - TransponderManager::CreateTimeshiftBuffer OK
23:12:16.757 - TimeShift.CreateReadingCursor
23:12:16.757 - TransponderChannelSource.Plugins 00000208A645A500 csa 0000000000000000
23:12:16.773 - TsInputTrafficProcessor.AddChannel 0
23:12:16.804 - SetChannelLogic::LookDeviceWithoutChannelsOrCloneAndMakeGraph
23:12:16.835 - ChannelGraph5.SetActiveState 1
23:12:16.835 - TransponderManager::SelectChannel
23:12:16.851 - TsInputTrafficProcessor.SelectChannel 0
23:12:16.866 - Api2BaseModule.UpdateAllOpenedChannels 0
23:12:16.882 - AV:UpdateAudioParamsAfterActive
23:12:16.898 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
23:12:16.913 - Graph::SetAudioChannelMask
23:12:16.929 - 
23:12:16.945 - TransponderManager::SetTransponder (CH) 0 DW
23:12:16.960 - *Transport TS
23:12:16.976 - Api2Device::SetChannel http://live-1.otcnet.ru/DW/tracks-v1a1/index.m3u8
23:12:17.054 - Api2Device::SetChannel result OK
23:12:17.054 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=1000
23:12:17.085 - TsInputTrafficProcessor.OpenTransponder 1
23:12:17.101 - Api2BaseModule.OnTunerStateChanged Connecting
23:12:17.101 - FilterManager::OnSetTransponder SetChannel
23:12:17.132 - TimeShift.Reset
23:12:17.132 - TimeShift.Cursor reset
23:12:17.132 - ReaderCursor::Reset.. OK
23:12:17.163 - Prereader.Reset ...-OK
23:12:17.195 - ModuleList::ChangeChannel 0
23:12:17.210 - [102]ChannelGraph5::StartChannel DW
23:12:17.226 - 
23:12:17.226 - [102]       #################### Start stream. (0.922ms) #######################
23:12:17.226 - 
23:12:17.257 - Api2BaseModule.OnTunerStateChanged Preparing
23:12:17.304 - Api2BaseModule.OnTunerStateChanged Playing
23:12:17.351 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
23:12:17.366 - TimeShift.Cursor SetChannel::v 0 (0)
23:12:17.382 - ReaderCursor::SetChannel.. OK
23:12:17.413 - ReaderCursor::SetPosition 0 (w=0)
23:12:17.429 - Prereader.SetChannel..
23:12:17.445 - Prereader.SetChannel unmask 1
23:12:17.460 - Plugin::SetChannel 1000
23:12:17.476 - TransponderManager::SelectChannel
23:12:17.491 - TsInputTrafficProcessor.SelectChannel 1000
23:12:17.507 - Api2BaseModule.UpdateAllOpenedChannels 1
23:12:17.523 - TsInputTrafficProcessor.UpdateChannel 1000
23:12:17.538 - GraphState: Undef by StartChannelIsReady
23:12:17.554 - PreScanner.StartChannelIsReady net=1 parseall=1
23:12:17.570 - VideoMediaTypeDetection: h.264
23:12:17.585 - SetMarkerAudioLngStream Gen New stream
23:12:17.616 - SimpleTsDemux::Init apid=221, vpid=211
23:12:17.616 - GraphState: RequestPATScan by StartChannelIsReady TS
23:12:17.616 - Api2BaseModule.Filters_EnabledFullTS 1
23:12:17.632 - PlayTimePATParser.OpenParser 1000
23:12:17.648 - Open TSTS filter pid=0 data=0
23:12:17.663 - TSTS cur size=0
23:12:17.695 - Graph::SetVideoRect {8 8 712 568}
23:12:17.710 - [102]OnChangeCurrentGraph2 -endOfSetChannel
23:12:17.726 - ChannelGraph5.SetActiveState 1
23:12:17.820 - Graph::SetVideoWindowRect {33 0 166 100}
23:12:17.820 - Graph::UpdateRenderMode
23:12:17.899 - GraphManager::MultiChannelRendering
23:12:17.899 - ChannelGraph5.SetActiveState 1
23:12:17.927 - Graph::SetVideoWindowRect {28 0 461 325}
23:12:18.153 - OK. 102
23:12:18.439 - OSDManager::Window_Add
23:12:18.455 - OSDManager::Window_Show
23:12:18.508 - * s:0 q:0 tr=0 (0) Preparing
23:12:18.579 - OSDManager::Window_Show
23:12:18.597 - OSDManager::Window_Show
23:12:19.127 - 
23:12:19.127 -        #################### First traffic. (2.812ms) #######################
23:12:19.152 - 
23:12:19.169 - PlayTimePATParser.EndTask
23:12:19.186 - TransportMarker: TS
23:12:19.186 - PreScanner.OnAfterScanPat count=2 {1000;4095}
23:12:19.204 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
23:12:19.236 - Api2BaseModule.Filters_EnabledFullTS 0
23:12:19.253 - GraphState: RequestPMTScan by OnAfterScanPat
23:12:19.270 - PlayTimePmtParser::OpenParser SID=1000 PMT=4095 unknow channel=1
23:12:19.287 - Open TSTS filter pid=4095 data=2
23:12:19.304 - TSTS cur size=273728
23:12:19.320 - TSTS quick finish
23:12:19.337 - --SwitchEngineTransport TS > TS
23:12:19.353 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
23:12:19.370 - PreScanner.OnTransportMarker TS
23:12:19.386 - --SwitchEngineTransport end
23:12:19.403 - PreScanner.OnAfterScanPmt pmt=4095
23:12:19.420 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
23:12:19.437 - PlayTimePmtParser::StopParser
23:12:19.653 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
23:12:19.654 - TimeShift.Cursor SetChannel::v 413224 (413224)
23:12:19.674 - Prereader.SetChannel unmask 1
23:12:19.696 - Plugin::SetChannel 1000
23:12:19.714 - TransponderManager::SelectChannel
23:12:19.731 - TsInputTrafficProcessor.SelectChannel 1000
23:12:19.747 - Api2BaseModule.UpdateAllOpenedChannels 1
23:12:19.763 - TsInputTrafficProcessor.UpdateChannel 1000
23:12:19.778 - PreScanner.StartChannelIsReady net=1 parseall=0
23:12:19.794 - LngDefaultSelector.try select audio pid=221 type=1 lng=7693668-deu(goh,goh,rus) l=99
23:12:19.810 - ChannelGraph5::AfterDetectChannelParams
23:12:19.826 - VideoMediaTypeDetection: h.264
23:12:19.841 - SimpleTsDemux::Init apid=221, vpid=211
23:12:19.857 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
23:12:19.873 - demux: ProgDemux
23:12:19.897 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
23:12:19.906 - Prereader::ReaderCursor.. OK
23:12:19.939 - ReaderCursor::SetPosition 0 (w=635628)
23:12:19.955 - Prereader.StartPlayback Push buffering=0 recv=00000208A722E4A8 [StartChannelHelperBase(sl)]
23:12:19.971 - Prereader.StartPlayback after lock
23:12:19.988 - PreScanner.StartPmtParserIfNeed
23:12:19.989 - AudioParser::First packet 178
23:12:20.022 - VideoParser::First packet 51487 h.264
23:12:20.037 - h264 detected 0 ms
23:12:20.054 - AudioParser::packet 194
23:12:20.069 - AudioParser::AAC detected
23:12:20.085 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
23:12:20.100 - PreScanner.Post_InitRender [ReceiveTraffic]
23:12:20.006 - PlayTimePmtParser::OpenParser SID=1000 PMT=4095 unknow channel=0
23:12:20.132 - Open TSTS filter pid=4095 data=2
23:12:20.148 - TSTS cur size=733952
23:12:20.265 - OSDManager::Window_Show
23:12:20.284 - [102]sm: TvInitRenderer 1
23:12:20.284 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
23:12:20.303 - CalculBufferingSize prov=00000208A6313B84 marker=1 request=1
23:12:20.319 - CalculBuffering 2000ms br=2000kb to 500 kbytes. By type
23:12:20.335 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
23:12:20.351 - Prereader::ReaderCursor.. OK
23:12:20.383 - ReaderCursor::SetPosition 0 (w=956544)
23:12:20.399 - Prereader.StartPlayback Pull buffering=512000 recv=0000000000000000 [EnablePullModeAndStartPlayback]
23:12:20.414 - Prereader.StartPlayback after lock
23:12:20.430 - Buffering/prereader size 500/3906 kbytes
23:12:20.446 - ------sGetVideoParams
23:12:20.463 - * s:100 q:100 tr=968764 (0) Preparing
23:12:20.468 - ChannelGraph5.CreateInterfacesAndRenderGraph
23:12:20.475 - subsm.StartChannel demux=ProgDemux tr=TS
23:12:20.492 - subsm.RecreateSubtitlesParsers 00000208B6389400 ts=1 subindex=-1
23:12:20.508 - subsm.Set Teletext parser 0
23:12:20.524 - subsm.RecreateSubtitlesParsers end
23:12:20.540 - subs: OnSetChannel
23:12:20.556 - CreateCustomGraph
23:12:20.572 - VideoType:H.264/AVC ffmpeg=0
23:12:20.587 - Video/4.H264 : MPEG2_VIDEO s={0,144,0,0}, t={0,144,0,0}, bmp=720x576, r=16/9, br=0,frametime=40ms, IF=0x0, CF=0x0)
23:12:20.603 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
23:12:20.621 - Create filter error (Video decoder ) - 0x80040154!
23:12:20.637 - CChannelGraph5::CreateRender 10
23:12:20.656 - VR: EVR Custom
23:12:20.657 - VR: create new render
23:12:20.794 - Video pin founded. Try to founded any good codec... OK.
23:12:20.794 - CreateAudioPartOfGraph
23:12:20.812 - AudioType:AAC/ADTS 
23:12:20.829 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
23:12:20.849 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
23:12:20.881 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
23:12:20.883 - Added audio renderer
23:12:20.913 - Add and connect audio renderer - OK
23:12:20.918 - Graph::AfterRender
23:12:20.935 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
23:12:20.951 - AV:UpdateAudioParamsAfterActive
23:12:20.968 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
23:12:20.985 - Graph::SetVolume 100% 0db
23:12:21.002 - Graph::SetAudioChannelMask
23:12:21.018 - Graph::Run
23:12:21.079 - Graph::Run 1
23:12:21.080 - Graph::SetPictureParams
23:12:21.096 - Graph::SetVideoRect {8 8 712 568}
23:12:21.112 - Graph::SetVideoWindowRect {0 25 490 300}
23:12:21.147 - 
23:12:21.170 - [0]########################### Mark of finish channel changing. (4.859ms) #############
23:12:21.189 - 
23:12:21.274 - 
23:12:21.275 - [0]########################### First video frame. (4.968ms) #############
23:12:21.294 - 
23:12:21.458 - CChannelGraph5::HideSubtitles
23:12:21.478 - * s:0 q:0 tr=0 (0) Playing
23:12:22.293 - * s:100 q:100 tr=225600 (0) Playing
23:12:23.291 - * s:100 q:100 tr=174464 (0) Playing
23:12:24.299 - * s:100 q:100 tr=0 (0) Playing
23:12:25.290 - * s:100 q:100 tr=186496 (0) Playing
23:12:26.290 - * s:100 q:100 tr=0 (0) Playing
23:12:27.272 - OSDManager::Window_Show
23:12:27.272 - OSDManager::Window_Delete
23:12:27.317 - * s:100 q:100 tr=309824 (0) Playing
23:12:28.169 - ChannelGraph5::StartRecord endtime=14days, 23:15:37 action=0 - "DW\05.14 - 23.09.27"
23:12:28.169 - Mpeg2FileWriter
23:12:28.188 - TimeShift.Cursor StartRecording 8 1
23:12:28.207 - ReaderCursor::SetPosition.. OK
23:12:28.245 - ReaderCursor::SetPosition 0 (w=1840896)
23:12:28.265 - PMT convertor
23:12:28.284 - ChannelGraph5::StartRecord OK C:\ProgramData\ProgDVB\Record\DW\05.14 - 23.09.27.ts
23:12:28.393 - OSDManager::Window_Add
23:12:28.434 - OSDManager::Window_Show
23:12:28.500 - OSDManager::Window_Show
23:12:28.594 - * s:100 q:100 tr=0 (0) Playing
23:12:29.289 - * s:100 q:100 tr=270720 (0) Playing
23:12:29.410 - OSDManager::Window_Show
23:12:30.290 - * s:100 q:100 tr=0 (0) Playing
23:12:30.414 - OSDManager::Window_Show
23:12:31.293 - * s:100 q:100 tr=213568 (0) Playing
23:12:31.404 - OSDManager::Window_Show
23:12:32.291 - * s:100 q:100 tr=0 (0) Playing
23:12:32.401 - OSDManager::Window_Show
23:12:33.291 - * s:100 q:100 tr=228608 (0) Playing
23:12:33.403 - OSDManager::Window_Show
23:12:34.290 - * s:100 q:100 tr=0 (0) Playing
23:12:34.408 - OSDManager::Window_Show
23:12:35.290 - * s:100 q:100 tr=144384 (0) Playing
23:12:35.432 - OSDManager::Window_Show
23:12:36.289 - * s:100 q:100 tr=0 (0) Playing
23:12:36.414 - OSDManager::Window_Show
23:12:37.289 - * s:100 q:100 tr=0 (0) Playing
23:12:37.415 - OSDManager::Window_Show
23:12:38.287 - * s:100 q:100 tr=493312 (0) Playing
23:12:38.470 - OSDManager::Window_Show
23:12:38.624 - [102]ChannelGraph5::StopRecord C:\ProgramData\ProgDVB\Record\DW\05.14 - 23.09.27.ts
23:12:38.644 - ChannelGraph5::StopRecord --debug 0
23:12:38.667 - ChannelGraph5::StopRecord --debug 1
23:12:38.686 - ChannelGraph5::StopRecord --debug 2
23:12:38.705 - TimeShift.Cursor StopRecording
23:12:38.724 - ChannelGraph5::StopRecord --debug 3
23:12:38.743 - ChannelGraph5::StopRecord --debug 4
23:12:38.763 - ChannelGraph5::StopRecord --debug 5
23:12:38.783 - ChannelGraph5::StopRecord --debug 6
23:12:38.801 - ChannelGraph5::StopRecord --debug 7
23:12:38.820 - ChannelGraph5::StopRecord --debug 8
23:12:38.839 - ChannelGraph5::StopRecord --debug 9
23:12:38.857 - ChannelGraph5::StopRecord --debug 9
23:12:38.876 - ChannelGraph5::StopRecord --debug 10
23:12:38.895 - ChannelGraph5::StopRecord --debug 11
23:12:38.926 - Stop recording finihed by Engine  action=0
23:12:39.027 - ChannelGraph5::StopRecord --debug 12
23:12:39.090 - ChannelGraph5::StopRecord --debug 13
23:12:39.108 - ChannelGraph5::StopRecord --debug 14
23:12:39.127 - ChannelGraph5::StopRecord --debug 15
23:12:39.216 - ChannelGraph5.~CChannelGraph5
23:12:39.235 - Graph::Stop
23:12:39.339 - Before Stop ...23:12:39.358 - OnGraphStop ...23:12:39.422 - PreScanner.Stop
23:12:39.440 - GraphState: Undef by PreScanner.Stop
23:12:39.459 - PlayTimePmtParser::StopParser
23:12:39.477 - subsm.StopChannel
23:12:39.495 - VR: Disconnect
23:12:39.513 - Graph::ReleaseAllFilters
23:12:39.538 - release: Prog Audio renderer - RR - OK.
23:12:39.707 - release: Video Renderer - RR - OK.
23:12:39.764 - release: Microsoft DTV-DVD Video Decoder - RR - OK.
23:12:39.804 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
23:12:39.842 - FilterGraph: 1
23:12:39.867 - ChannelGraph5.~CChannelGraph5 finish
23:12:39.905 - TransponderManager::CloseChannel
23:12:39.925 - TsInputTrafficProcessor.RemoveChannel 1000
23:12:39.944 - ~TransponderChannelSource
23:12:40.077 - TimeShift.DestroyReadingCursor
23:12:40.099 - Api2BaseModule.UpdateAllOpenedChannels 0
23:12:40.117 - Destroy TSTS filter pid=0
23:12:40.135 - PlayTimePmtParser::StopParser
23:12:40.148 - Destroy TSTS filter pid=4095
23:12:40.168 - DevicesManager::DestroyTransponderManager
23:12:40.188 - Api2Device::SetChannel - None
23:12:40.217 - skip old generation traffic!
23:12:40.338 - Api2Device::SetChannel result OK
23:12:40.338 - SetOwner N -> 0
23:12:40.350 - SetOwner SetTransponder null
23:12:40.370 - ~TransponderManager
23:12:40.390 - SetOwner N -> 0
23:12:40.410 - SetOwner SetTransponder null
23:12:40.449 - TimeShift.~TimeShift
23:12:40.461 - HugeMemoryBlocksManager::Free
23:12:40.481 - ModuleList::Free
23:12:40.511 - [103]OnChangeCurrentGraph2 -CloseGraph
23:12:40.622 - VR: GUI
23:12:40.693 - GraphManager::MultiChannelRendering
23:12:41.167 - [104]OnChangeCurrentGraph2 -CloseGraph
23:12:41.265 - VR: GUI
23:12:41.338 - GraphManager::MultiChannelRendering
23:12:42.086 - [105]OnChangeCurrentGraph2 -CloseGraph
23:12:42.180 - VR: GUI
23:12:42.243 - GraphManager::MultiChannelRendering
23:13:37.000 - 
23:13:37.000 - Stop engine
23:13:37.015 - DevicesManager::Stop
23:13:37.046 - DevicesManager::Free devices
23:13:37.053 - SDP:Destroy netclient.0 own=0000000000000000
23:13:37.100 - SDP:after destroy device
23:13:37.100 - DevicesManager::Free RC
23:13:37.115 - Engine stopped
23:13:37.184 - 
23:13:37.184 - Stop engine
23:13:37.200 - DevicesManager::Stop
23:13:37.216 - DevicesManager::Free devices
23:13:37.231 - Engine stopped
23:13:37.448 - HugeMemoryBlocksManager::FreeAll
