﻿13:17:53.521 - Start logging...
13:17:53.527 - ExceptionFilter::Init. restart=1
13:17:54.105 - DevicesManager::EnableCISupport
13:17:54.106 - CAVManager::SetSettings
13:17:54.106 - DevicesManager::DestroyAllTransponderManager
13:17:54.119 - SetDefaultNullCodecs
13:17:54.138 - SetDefaultNullCodecs
13:17:54.146 - DevicesManager::Start
13:17:54.147 - AVManager::Init
13:17:54.147 - RemoveAllCreateBlank needBlank1
13:17:54.149 - add graph 0000028468365150 101
13:17:54.149 - [101]OnChangeCurrentGraph2 -RemoveAllBlank
13:17:54.156 - VR: GUI
13:17:54.159 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:17:54.180 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:17:54.181 - AV:UpdateAudioParamsAfterActive
13:17:54.181 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:17:54.182 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:17:54.250 - remove graph idx=0 count=1
13:17:54.251 - DevicesManager::StartDevices...
13:17:54.252 - device netclient.0 13:17:54.255 - dev: Created  netclient.0 00000284653BBF50
OK
13:17:54.257 - Api2BaseModule.GetAdditionInfo
13:17:54.662 - 
13:17:54.662 - 
13:17:54.663 - ########################### Mark of start channel changing.###########################
13:17:54.663 - 
13:17:54.664 - GraphManager::MainChangeChannel Футбол 2  1 provs
13:17:54.664 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
13:17:54.664 - SetChannelLogic::SetChannel 0
13:17:54.665 - SetChannelLogic::SetNormalChannel
13:17:54.665 - DevicesManager::CreateCloneDevice
13:17:54.666 - DevicesManager::CreateCloneDevice OK - founded in list
13:17:54.666 - TransponderManager
13:17:54.667 - CTransponderManager::InitOnNewDevice 00000284683A0078
13:17:54.668 - SetOwner N -> Incoming Stream Cache
13:17:54.669 - TrafficProcessingScheme_CreateForNewEngineTransport 1 ss=0
13:17:54.669 - Normal TsInputTrafficProcessor.
13:17:54.672 - FilterManager::InitOnNewDevice 1
13:17:54.673 - TS router+MarkerFinder -> InputTrafficProcessor
13:17:54.674 - Incoming Stream Cache -> TS router+MarkerFinder
13:17:54.674 - InputTrafficProcessor -> Router to timeshift
13:17:54.675 - InputTrafficProcessor(FM) -> FilterManager
13:17:54.675 - ModuleList::Free
13:17:54.676 - Api2BaseModule::GetCurrentDeviceInfo
13:17:54.677 - ModuleList::Load C:\Program Files\ProgDVB x64 Network Edition\Modules\PidRecorder.module OK
13:17:54.678 - Api2BaseModule::GetCurrentDeviceInfo
13:17:54.680 - ModuleList::Load C:\Program Files\ProgDVB x64 Network Edition\Modules\ProgMediaServer.Module OK
13:17:54.681 - ChannelGraph5.CChannelGraph5
13:17:54.681 - TransponderManager::AddChildChannel
13:17:54.682 - TimeShift.TimeShift
13:17:54.683 - TimeShift.Create 200 mbytes 
13:17:54.683 - ts:One channel
13:17:54.684 - HugeMemoryBlocksManager::GetBlock 200 mbytes OK
13:17:54.685 - TransponderManager::CreateTimeshiftBuffer OK
13:17:54.694 - TimeShift.CreateReadingCursor
13:17:54.694 - TransponderChannelSource.Plugins 0000028468373540 csa 0000000000000000
13:17:54.695 - TsInputTrafficProcessor.AddChannel 0
13:17:54.697 - SetChannelLogic::LookDeviceWithoutChannelsOrCloneAndMakeGraph
13:17:54.697 - add graph 000002846B2E4E38 102
13:17:54.699 - ChannelGraph5.SetActiveState 1
13:17:54.700 - TransponderManager::SelectChannel
13:17:54.700 - TsInputTrafficProcessor.SelectChannel 0
13:17:54.701 - Api2BaseModule.UpdateAllOpenedChannels 0
13:17:54.702 - AV:UpdateAudioParamsAfterActive
13:17:54.703 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:17:54.704 - GR:UpdateAudioProcessor old=0 new=0
13:17:54.705 - Graph::SetAudioChannelMask
13:17:54.706 - 
13:17:54.707 - TransponderManager::SetTransponder (CH) 0 Футбол 2
13:17:54.708 - *Transport TS
13:17:54.708 - Api2Device::SetChannel http://hls2.lan.ua:8156/index.m3u8
13:17:54.713 - Api2Device::SetChannel result OK
13:17:54.714 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=1
13:17:54.715 - Api2BaseModule.OnTunerStateChanged Connecting
13:17:54.715 - TsInputTrafficProcessor.OpenTransponder 1
13:17:54.717 - FilterManager::OnSetTransponder SetChannel
13:17:54.716 - Api2BaseModule.OnTunerStateChanged  -3
13:17:54.718 - TimeShift.Reset
13:17:54.720 - TimeShift.Cursor reset
13:17:54.722 - ReaderCursor::Reset.. OK
13:17:54.724 - Prereader.Reset ...-OK
13:17:54.726 - ModuleList::ChangeChannel 0
13:17:54.727 - [102]ChannelGraph5::StartChannel Футбол 2
13:17:54.728 - 
13:17:54.730 - [102]       #################### Start stream. (0.079ms) #######################
13:17:54.730 - Api2BaseModule.OnTunerStateChanged Preparing
13:17:54.731 - 
13:17:54.732 - Api2BaseModule.OnTunerStateChanged  -4
13:17:54.736 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
13:17:54.738 - TimeShift.Cursor SetChannel::v 0 (0)
13:17:54.739 - ReaderCursor::SetChannel.. OK
13:17:54.741 - ReaderCursor::SetPosition 0 (w=0)
13:17:54.743 - Prereader.SetChannel..
13:17:54.740 - Api2BaseModule.OnTunerStateChanged Playing
13:17:54.744 - Prereader.SetChannel unmask 1
13:17:54.747 - Plugin::SetChannel 1
13:17:54.747 - Api2BaseModule.OnTunerStateChanged  -4
13:17:54.748 - TransponderManager::SelectChannel
13:17:54.750 - TsInputTrafficProcessor.SelectChannel 1
13:17:54.752 - Api2BaseModule.UpdateAllOpenedChannels 1
13:17:54.754 - TsInputTrafficProcessor.UpdateChannel 1
13:17:54.755 - GraphState: Undef by StartChannelIsReady
13:17:54.757 - PreScanner.StartChannelIsReady net=1 parseall=1
13:17:54.758 - VideoMediaTypeDetection: h.264
13:17:54.759 - SetMarkerAudioLngStream Gen New stream
13:17:54.761 - SimpleTsDemux::Init apid=257, vpid=256
13:17:54.762 - GraphState: RequestPATScan by StartChannelIsReady TS
13:17:54.763 - Api2BaseModule.Filters_EnabledFullTS 1
13:17:54.765 - PlayTimePATParser.OpenParser 1
13:17:54.767 - Open TSTS filter pid=0 data=0
13:17:54.768 - TSTS cur size=0
13:17:54.769 - Graph::SetVideoRect {8 8 712 568}
13:17:54.770 - [102]OnChangeCurrentGraph2 -endOfSetChannel
13:17:54.772 - ChannelGraph5.SetActiveState 1
13:17:54.781 - Graph::SetVideoWindowRect {33 0 166 100}
13:17:54.782 - Graph::UpdateRenderMode
13:17:54.835 - GraphManager::MultiChannelRendering
13:17:54.836 - ChannelGraph5.SetActiveState 1
13:17:54.842 - Graph::SetVideoWindowRect {115 0 804 517}
13:17:54.852 - Graph::SetVideoWindowRect {115 0 804 517}
13:17:54.867 - Graph::SetVideoWindowRect {115 0 804 517}
13:17:54.892 - OK. 102
13:17:54.926 - Api2BaseModule.EngineApi_ChList_SendSubChannels 0/2
13:17:54.972 - TransportMarker: TS
13:17:54.974 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:17:54.975 - 
13:17:54.976 -        #################### First traffic. (0.329ms) #######################
13:17:54.978 - 
13:17:54.979 - PlayTimePATParser.EndTask
13:17:54.984 - --SwitchEngineTransport TS > TS
13:17:54.986 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:17:54.988 - PreScanner.OnTransportMarker TS
13:17:54.989 - --SwitchEngineTransport end
13:17:54.990 - PreScanner.OnAfterScanPat count=2 {1;4096}
13:17:54.992 - Api2BaseModule.Filters_EnabledFullTS 0
13:17:54.994 - GraphState: RequestPMTScan by OnAfterScanPat
13:17:54.995 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=1
13:17:54.996 - Open TSTS filter pid=4096 data=2
13:17:54.998 - TSTS cur size=333888
13:17:54.999 - TSTS quick finish
13:17:55.013 - PreScanner.OnAfterScanPmt pmt=4096
13:17:55.014 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
13:17:55.016 - PlayTimePmtParser::StopParser
13:17:55.027 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
13:17:55.028 - TimeShift.Cursor SetChannel::v 405328 (405328)
13:17:55.030 - Prereader.SetChannel unmask 1
13:17:55.031 - Plugin::SetChannel 1
13:17:55.032 - TransponderManager::SelectChannel
13:17:55.033 - TsInputTrafficProcessor.SelectChannel 1
13:17:55.035 - Api2BaseModule.UpdateAllOpenedChannels 1
13:17:55.037 - TsInputTrafficProcessor.UpdateChannel 1
13:17:55.038 - PreScanner.StartChannelIsReady net=1 parseall=0
13:17:55.040 - LngDefaultSelector.try select audio pid=257 type=1 lng=7498613-ukr(deu,deu,rus) l=99
13:17:55.041 - ChannelGraph5::AfterDetectChannelParams
13:17:55.043 - VideoMediaTypeDetection: h.264
13:17:55.044 - SimpleTsDemux::Init apid=257, vpid=256
13:17:55.046 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
13:17:55.047 - demux: ProgDemux
13:17:55.056 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
13:17:55.058 - Prereader::ReaderCursor.. OK
13:17:55.061 - ReaderCursor::SetPosition 0 (w=945452)
13:17:55.062 - Prereader.StartPlayback Push buffering=0 recv=000002846B2E5DF8 [StartChannelHelperBase(sl)]
13:17:55.064 - Prereader.StartPlayback after lock
13:17:55.065 - PreScanner.StartPmtParserIfNeed
13:17:55.066 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=0
13:17:55.067 - Open TSTS filter pid=4096 data=2
13:17:55.068 - VideoParser::First packet 41730 h.264
13:17:55.070 - TSTS cur size=1051860
13:17:55.072 - h264 detected 0 ms
13:17:55.075 - AudioParser::First packet 2005
13:17:55.076 - AudioParser::AAC detected
13:17:55.078 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
13:17:55.079 - PreScanner.Post_InitRender [ReceiveTraffic]
13:17:55.083 - [102]sm: TvInitRenderer 1
13:17:55.084 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
13:17:55.086 - CalculBufferingSize prov=00000284683A14F4 marker=1 request=1
13:17:55.088 - CalculBuffering 2000ms br=4523kb to 1130 kbytes. from marker
13:17:55.089 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
13:17:55.090 - Prereader::ReaderCursor.. OK
13:17:55.093 - ReaderCursor::SetPosition 0 (w=1453052)
13:17:55.095 - Prereader.StartPlayback Pull buffering=1158000 recv=0000000000000000 [EnablePullModeAndStartPlayback]
13:17:55.096 - Prereader.StartPlayback after lock
13:17:55.098 - Buffering/prereader size 1130/3906 kbytes
13:17:55.099 - ------sGetVideoParams
13:17:55.100 - ChannelGraph5.CreateInterfacesAndRenderGraph
13:17:55.101 - * s:100 q:100 tr=1525808 (0) Preparing
13:17:55.105 - OnBuffering.OnTunerStateChanged  4
13:17:55.107 - subsm.StartChannel demux=ProgDemux tr=TS
13:17:55.109 - subsm.RecreateSubtitlesParsers 00000284682D3080 ts=1 subindex=-1
13:17:55.110 - subsm.Set Teletext parser 0
13:17:55.112 - subsm.RecreateSubtitlesParsers end
13:17:55.113 - subs: OnSetChannel
13:17:55.115 - CreateCustomGraph
13:17:55.116 - VideoType:H.264/AVC ffmpeg=0
13:17:55.117 - Video/4.H264 : MPEG2_VIDEO s={0,0,720,576}, t={0,0,720,576}, bmp=720x576, r=254/139, br=0,frametime=40ms, IF=0x0, CF=0x0)
13:17:55.120 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
13:17:55.153 - OK
13:17:55.155 - CChannelGraph5::CreateRender 10
13:17:55.157 - VR: EVR Custom
13:17:55.159 - VR: create new render
13:17:55.199 - VR: Add video renderer Video Renderer - OK
13:17:55.201 - CreateAudioPartOfGraph
13:17:55.202 - AudioType:AAC/ADTS 
13:17:55.205 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
13:17:55.207 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
13:17:55.219 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
13:17:55.221 - Added audio renderer
13:17:55.222 - AP: created
13:17:55.224 - Added audio processor
13:17:55.229 - Connect codec to AP - OK
13:17:55.243 - Add and connect audio renderer - OK
13:17:55.244 - Graph::AfterRender
13:17:55.246 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
13:17:55.247 - AV:UpdateAudioParamsAfterActive
13:17:55.249 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:17:55.250 - GR:UpdateAudioProcessor old=1 new=0
13:17:55.252 - Destroy Audio Processor udate
13:17:55.253 - Graph::SetVolume 5% -5402db
13:17:55.256 - Graph::SetAudioChannelMask
13:17:55.258 - Graph::Run
13:17:55.295 - Graph::Run 1
13:17:55.298 - Graph::SetPictureParams
13:17:55.300 - Graph::SetVideoRect {8 8 712 568}
13:17:55.302 - Graph::SetVideoWindowRect {0 7 919 509}
13:17:55.340 - CChannelGraph5::HideSubtitles
13:17:55.357 - 
13:17:55.359 - [0]########################### Mark of finish channel changing. (0.704ms) #############
13:17:55.361 - 
13:17:55.469 - 
13:17:55.475 - [0]########################### First video frame. (0.813ms) #############
13:17:55.477 - 
13:17:55.914 - * s:100 q:100 tr=5668576 (0) Playing
13:17:56.918 - * s:100 q:100 tr=0 (0) Playing
13:17:57.915 - * s:100 q:100 tr=0 (0) Playing
13:17:58.916 - * s:100 q:100 tr=0 (0) Playing
13:17:59.437 - 
13:17:59.438 - 
13:17:59.440 - ########################### Mark of start channel changing.###########################
13:17:59.442 - 
13:17:59.443 - GraphManager::MainChangeChannel Футбол 1  1 provs
13:17:59.445 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
13:17:59.446 - SetChannelLogic::SetChannel 0
13:17:59.448 - SetChannelLogic::SetNormalChannel
13:17:59.452 - ChannelGraph5::StopChannel Футбол 1
13:17:59.453 - PreScanner.Stop
13:17:59.455 - GraphState: Undef by PreScanner.Stop
13:17:59.458 - PlayTimePmtParser::StopParser
13:17:59.459 - TimeShift.Cursor PushMode 0 0 (pos=0) [Engine5ChannelBase.StopChannel]
13:17:59.461 - Prereader::ReaderCursor.. OK
13:17:59.464 - ReaderCursor::SetPosition 0 (w=8779036)
13:17:59.465 - Prereader.StartPlayback Disable buffering=0 recv=0000000000000000 [Engine5ChannelBase.StopChannel]
13:17:59.467 - Prereader.StartPlayback after lock
13:17:59.468 - subsm.StopChannel
13:17:59.470 - Graph::Stop
13:17:59.500 - Before Stop ...13:17:59.503 - OnGraphStop ...13:17:59.519 - VR: Disconnect
13:17:59.544 - Graph::ReleaseAllFilters
13:17:59.545 - release: Prog Audio renderer - RR - OK.
13:17:59.553 - release: Video Renderer - RR - OK.
13:17:59.564 - release: Video decoder  - RR - OK.
13:17:59.571 - release: Audio Processor - RR - OK.
13:17:59.575 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
13:17:59.578 - FilterGraph: 1
13:17:59.580 - 
13:17:59.582 - TransponderManager::SetTransponder (CH) 0 Футбол 1
13:17:59.583 - *Transport TS
13:17:59.585 - Api2Device::SetChannel http://hls2.lan.ua:8123/index.m3u8
13:17:59.593 - Api2Device::SetChannel result OK
13:17:59.593 - Api2BaseModule.OnTunerStateChanged Connecting
13:17:59.594 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=1
13:17:59.595 - Api2BaseModule.OnTunerStateChanged  -3
13:17:59.597 - TsInputTrafficProcessor.OpenTransponder 1
13:17:59.600 - FilterManager::OnSetTransponder SetChannel
13:17:59.601 - TimeShift.Reset
13:17:59.603 - TimeShift.Cursor reset
13:17:59.604 - ReaderCursor::Reset.. OK
13:17:59.604 - Api2BaseModule.OnTunerStateChanged Preparing
13:17:59.608 - Prereader.Reset ...13:17:59.610 - Api2BaseModule.OnTunerStateChanged  -4
-OK
13:17:59.614 - ModuleList::ChangeChannel 0
13:17:59.616 - [102]ChannelGraph5::StartChannel Футбол 1
13:17:59.617 - 
13:17:59.618 - Api2BaseModule.OnTunerStateChanged Playing
13:17:59.618 - [102]       #################### Start stream. (0.187ms) #######################
13:17:59.620 - Api2BaseModule.OnTunerStateChanged  -4
13:17:59.622 - 
13:17:59.635 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
13:17:59.637 - TimeShift.Cursor SetChannel::v 0 (0)
13:17:59.638 - ReaderCursor::SetChannel.. OK
13:17:59.641 - ReaderCursor::SetPosition 0 (w=0)
13:17:59.643 - Prereader.SetChannel..
13:17:59.644 - Prereader.SetChannel unmask 1
13:17:59.646 - Plugin::SetChannel 1
13:17:59.647 - TransponderManager::SelectChannel
13:17:59.648 - TsInputTrafficProcessor.SelectChannel 1
13:17:59.650 - Api2BaseModule.UpdateAllOpenedChannels 1
13:17:59.653 - TsInputTrafficProcessor.UpdateChannel 1
13:17:59.654 - GraphState: Undef by StartChannelIsReady
13:17:59.656 - PreScanner.StartChannelIsReady net=1 parseall=1
13:17:59.658 - VideoMediaTypeDetection: h.264
13:17:59.659 - SetMarkerAudioLngStream Gen New stream
13:17:59.661 - SimpleTsDemux::Init apid=257, vpid=256
13:17:59.662 - GraphState: RequestPATScan by StartChannelIsReady TS
13:17:59.664 - Api2BaseModule.Filters_EnabledFullTS 1
13:17:59.666 - PlayTimePATParser.OpenParser 1
13:17:59.668 - Open TSTS filter pid=0 data=0
13:17:59.670 - TSTS cur size=0
13:17:59.671 - Graph::UpdateRenderMode
13:17:59.733 - Graph::SetVideoRect {8 8 712 568}
13:17:59.735 - Graph::SetVideoWindowRect {0 7 919 509}
13:17:59.736 - [102]OnChangeCurrentGraph2 -endOfSetChannel
13:17:59.738 - ChannelGraph5.SetActiveState 1
13:17:59.796 - OSDManager::Window_Add
13:17:59.799 - OSDManager::Window_Show
13:17:59.813 - * s:0 q:0 tr=0 (0) Preparing
13:17:59.831 - OSDManager::Window_Show
13:17:59.835 - OSDManager::Window_Show
13:17:59.900 - OK. 102
13:17:59.928 - Api2BaseModule.EngineApi_ChList_SendSubChannels 0/2
13:17:59.984 - TransportMarker: TS
13:17:59.985 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:17:59.987 - 
13:17:59.988 - --SwitchEngineTransport TS > TS
13:17:59.990 -        #################### First traffic. (0.547ms) #######################
13:17:59.993 - 
13:17:59.995 - PlayTimePATParser.EndTask
13:17:59.997 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:17:59.998 - PreScanner.OnTransportMarker TS
13:18:00.000 - --SwitchEngineTransport end
13:18:00.002 - PreScanner.OnAfterScanPat count=2 {1;4096}
13:18:00.004 - Api2BaseModule.Filters_EnabledFullTS 0
13:18:00.007 - GraphState: RequestPMTScan by OnAfterScanPat
13:18:00.009 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=1
13:18:00.011 - Open TSTS filter pid=4096 data=2
13:18:00.013 - TSTS cur size=275420
13:18:00.015 - TSTS quick finish
13:18:00.030 - OSDManager::Window_Show
13:18:00.038 - PreScanner.OnAfterScanPmt pmt=4096
13:18:00.040 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
13:18:00.042 - PlayTimePmtParser::StopParser
13:18:00.056 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
13:18:00.058 - TimeShift.Cursor SetChannel::v 860664 (860664)
13:18:00.060 - Prereader.SetChannel unmask 1
13:18:00.061 - Plugin::SetChannel 1
13:18:00.063 - TransponderManager::SelectChannel
13:18:00.065 - TsInputTrafficProcessor.SelectChannel 1
13:18:00.066 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:00.069 - TsInputTrafficProcessor.UpdateChannel 1
13:18:00.070 - PreScanner.StartChannelIsReady net=1 parseall=0
13:18:00.073 - LngDefaultSelector.try select audio pid=257 type=1 lng=7498613-ukr(deu,deu,rus) l=99
13:18:00.074 - ChannelGraph5::AfterDetectChannelParams
13:18:00.076 - VideoMediaTypeDetection: h.264
13:18:00.078 - SimpleTsDemux::Init apid=257, vpid=256
13:18:00.080 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
13:18:00.081 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
13:18:00.083 - Prereader::ReaderCursor.. OK
13:18:00.086 - ReaderCursor::SetPosition 0 (w=1114652)
13:18:00.088 - Prereader.StartPlayback Push buffering=0 recv=000002846B2E5DF8 [StartChannelHelperBase(sl)]
13:18:00.090 - Prereader.StartPlayback after lock
13:18:00.092 - PreScanner.StartPmtParserIfNeed
13:18:00.092 - VideoParser::First packet 15027 h.264
13:18:00.094 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=0
13:18:00.096 - VideoParser::packet 16173
13:18:00.098 - Open TSTS filter pid=4096 data=2
13:18:00.099 - VideoParser::packet 27483
13:18:00.101 - TSTS cur size=1264864
13:18:00.103 - VideoParser::packet 28685
13:18:00.107 - VideoParser::packet 33172
13:18:00.109 - VideoParser::packet 37706
13:18:00.111 - AudioParser::First packet 2017
13:18:00.113 - VideoParser::packet 45063
13:18:00.115 - VideoParser::packet 52154
13:18:00.117 - VideoParser::packet 68203
13:18:00.119 - VideoParser::packet 70929
13:18:00.121 - AudioParser::packet 2048
13:18:00.127 - AudioParser::AAC detected
13:18:00.128 - VideoParser::packet 82220
13:18:00.130 - VideoParser::packet 85010
13:18:00.132 - VideoParser::packet 93797
13:18:00.134 - VideoParser::packet 102558
13:18:00.137 - VideoParser::packet 111827
13:18:00.138 - VideoParser::packet 121207
13:18:00.142 - VideoParser::packet 136109
13:18:00.144 - VideoParser::packet 140179
13:18:00.237 - VideoParser::packet 149627
13:18:00.239 - VideoParser::packet 153107
13:18:00.242 - VideoParser::packet 159255
13:18:00.245 - VideoParser::packet 165364
13:18:00.247 - VideoParser::packet 171540
13:18:00.250 - VideoParser::packet 177659
13:18:00.252 - VideoParser::packet 194447
13:18:00.254 - VideoParser::packet 198973
13:18:00.256 - VideoParser::packet 211017
13:18:00.259 - VideoParser::packet 215452
13:18:00.262 - VideoParser::packet 222721
13:18:00.264 - VideoParser::packet 230036
13:18:00.266 - VideoParser::packet 236544
13:18:00.268 - VideoParser::packet 243160
13:18:00.270 - VideoParser::packet 262577
13:18:00.272 - VideoParser::packet 268104
13:18:00.275 - VideoParser::packet 277109
13:18:00.277 - VideoParser::packet 279995
13:18:00.279 - VideoParser::packet 285388
13:18:00.281 - VideoParser::packet 290636
13:18:00.284 - VideoParser::packet 296639
13:18:00.286 - VideoParser::packet 302438
13:18:00.288 - VideoParser::packet 342065
13:18:00.290 - h264 detected 203 ms
13:18:00.293 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
13:18:00.295 - PreScanner.Post_InitRender [ReceiveTraffic]
13:18:00.297 - [102]sm: TvInitRenderer 1
13:18:00.299 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
13:18:00.301 - CalculBufferingSize prov=00000284683A14F4 marker=1 request=1
13:18:00.303 - CalculBuffering 2000ms br=4366kb to 1091 kbytes. from marker
13:18:00.305 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
13:18:00.307 - Prereader::ReaderCursor.. OK
13:18:00.311 - ReaderCursor::SetPosition 0 (w=3385880)
13:18:00.313 - Prereader.StartPlayback Pull buffering=1117750 recv=0000000000000000 [EnablePullModeAndStartPlayback]
13:18:00.315 - Prereader.StartPlayback after lock
13:18:00.317 - Buffering/prereader size 1091/3906 kbytes
13:18:00.319 - ------sGetVideoParams
13:18:00.321 - ChannelGraph5.CreateInterfacesAndRenderGraph
13:18:00.321 - * s:100 q:100 tr=3434948 (0) Preparing
13:18:00.326 - OnBuffering.OnTunerStateChanged  4
13:18:00.326 - subsm.StartChannel demux=ProgDemux tr=TS
13:18:00.330 - subsm.RecreateSubtitlesParsers 00000284682D3080 ts=1 subindex=-1
13:18:00.332 - subsm.Set Teletext parser 0
13:18:00.333 - subsm.RecreateSubtitlesParsers end
13:18:00.335 - subs: OnSetChannel
13:18:00.336 - CreateCustomGraph
13:18:00.338 - VideoType:H.264/AVC ffmpeg=0
13:18:00.340 - Video/4.H264 : MPEG2_VIDEO s={0,0,720,576}, t={0,0,720,576}, bmp=720x576, r=254/139, br=0,frametime=40ms, IF=0x0, CF=0x0)
13:18:00.342 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
13:18:00.371 - OK
13:18:00.373 - CChannelGraph5::CreateRender 10
13:18:00.375 - VR: EVR Custom
13:18:00.377 - VR: create new render
13:18:00.419 - VR: Add video renderer Video Renderer - OK
13:18:00.421 - CreateAudioPartOfGraph
13:18:00.424 - AudioType:AAC/ADTS 
13:18:00.426 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
13:18:00.429 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
13:18:00.438 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
13:18:00.440 - Added audio renderer
13:18:00.442 - AP: created
13:18:00.444 - Added audio processor
13:18:00.454 - Connect codec to AP - OK
13:18:00.471 - Add and connect audio renderer - OK
13:18:00.473 - Graph::AfterRender
13:18:00.476 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
13:18:00.478 - AV:UpdateAudioParamsAfterActive
13:18:00.480 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:18:00.482 - GR:UpdateAudioProcessor old=1 new=0
13:18:00.483 - Destroy Audio Processor udate
13:18:00.485 - Graph::SetVolume 5% -5402db
13:18:00.489 - Graph::SetAudioChannelMask
13:18:00.491 - Graph::Run
13:18:00.539 - Graph::Run 1
13:18:00.543 - Graph::SetPictureParams
13:18:00.545 - Graph::SetVideoRect {8 8 712 568}
13:18:00.547 - Graph::SetVideoWindowRect {0 7 919 509}
13:18:00.585 - CChannelGraph5::HideSubtitles
13:18:00.630 - 
13:18:00.631 - [0]########################### Mark of finish channel changing. (1.187ms) #############
13:18:00.633 - 
13:18:00.926 - * s:100 q:100 tr=3528760 (0) Playing
13:18:01.245 - 
13:18:01.246 - [0]########################### First video frame. (1.812ms) #############
13:18:01.248 - 
13:18:01.748 - * s:100 q:100 tr=0 (0) Playing
13:18:02.747 - * s:100 q:100 tr=0 (0) Playing
13:18:03.077 - 
13:18:03.079 - 
13:18:03.081 - ########################### Mark of start channel changing.###########################
13:18:03.083 - 
13:18:03.085 - GraphManager::MainChangeChannel Фауна  1 provs
13:18:03.087 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
13:18:03.089 - SetChannelLogic::SetChannel 0
13:18:03.090 - SetChannelLogic::SetNormalChannel
13:18:03.096 - ChannelGraph5::StopChannel Фауна
13:18:03.098 - PreScanner.Stop
13:18:03.100 - GraphState: Undef by PreScanner.Stop
13:18:03.103 - PlayTimePmtParser::StopParser
13:18:03.105 - TimeShift.Cursor PushMode 0 0 (pos=0) [Engine5ChannelBase.StopChannel]
13:18:03.108 - Prereader::ReaderCursor.. OK
13:18:03.111 - ReaderCursor::SetPosition 0 (w=6959008)
13:18:03.113 - Prereader.StartPlayback Disable buffering=0 recv=0000000000000000 [Engine5ChannelBase.StopChannel]
13:18:03.115 - Prereader.StartPlayback after lock
13:18:03.118 - subsm.StopChannel
13:18:03.119 - Graph::Stop
13:18:03.148 - Before Stop ...13:18:03.152 - OnGraphStop ...13:18:03.167 - VR: Disconnect
13:18:03.191 - Graph::ReleaseAllFilters
13:18:03.193 - release: Prog Audio renderer - RR - OK.
13:18:03.200 - release: Video Renderer - RR - OK.
13:18:03.212 - release: Video decoder  - RR - OK.
13:18:03.220 - release: Audio Processor - RR - OK.
13:18:03.224 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
13:18:03.228 - FilterGraph: 1
13:18:03.231 - 
13:18:03.233 - TransponderManager::SetTransponder (CH) 0 Фауна
13:18:03.234 - *Transport TS
13:18:03.236 - Api2Device::SetChannel http://hls2.lan.ua:8098/index.m3u8
13:18:03.249 - Api2BaseModule.OnTunerStateChanged Connecting
13:18:03.249 - Api2Device::SetChannel result OK
13:18:03.251 - Api2BaseModule.OnTunerStateChanged  -3
13:18:03.253 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=43981
13:18:03.256 - TsInputTrafficProcessor.OpenTransponder 1
13:18:03.258 - FilterManager::OnSetTransponder SetChannel
13:18:03.261 - TimeShift.Reset
13:18:03.263 - TimeShift.Cursor reset
13:18:03.264 - Api2BaseModule.OnTunerStateChanged Preparing
13:18:03.265 - ReaderCursor::Reset.. OK
13:18:03.267 - Api2BaseModule.OnTunerStateChanged  -4
13:18:03.271 - Prereader.Reset ...-OK
13:18:03.278 - ModuleList::ChangeChannel 0
13:18:03.278 - [102]ChannelGraph5::StartChannel Фауна
13:18:03.280 - Api2BaseModule.OnTunerStateChanged Playing
13:18:03.281 - 
13:18:03.283 - Api2BaseModule.OnTunerStateChanged  -4
13:18:03.285 - [102]       #################### Start stream. (0.203ms) #######################
13:18:03.289 - 
13:18:03.303 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
13:18:03.305 - TimeShift.Cursor SetChannel::v 0 (0)
13:18:03.306 - ReaderCursor::SetChannel.. OK
13:18:03.311 - ReaderCursor::SetPosition 0 (w=0)
13:18:03.313 - Prereader.SetChannel..
13:18:03.315 - Prereader.SetChannel unmask 1
13:18:03.317 - Plugin::SetChannel 43981
13:18:03.319 - TransponderManager::SelectChannel
13:18:03.321 - TsInputTrafficProcessor.SelectChannel 43981
13:18:03.323 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:03.326 - TsInputTrafficProcessor.UpdateChannel 43981
13:18:03.328 - GraphState: Undef by StartChannelIsReady
13:18:03.330 - PreScanner.StartChannelIsReady net=1 parseall=1
13:18:03.332 - VideoMediaTypeDetection: mpeg2
13:18:03.334 - SetMarkerAudioLngStream Gen New stream
13:18:03.336 - SimpleTsDemux::Init apid=257, vpid=100
13:18:03.338 - GraphState: RequestPATScan by StartChannelIsReady TS
13:18:03.341 - Api2BaseModule.Filters_EnabledFullTS 1
13:18:03.345 - PlayTimePATParser.OpenParser 43981
13:18:03.347 - Open TSTS filter pid=0 data=0
13:18:03.349 - TSTS cur size=0
13:18:03.350 - Graph::UpdateRenderMode
13:18:03.381 - Graph::SetVideoRect {8 8 712 568}
13:18:03.383 - Graph::SetVideoWindowRect {0 7 919 509}
13:18:03.385 - [102]OnChangeCurrentGraph2 -endOfSetChannel
13:18:03.387 - ChannelGraph5.SetActiveState 1
13:18:03.407 - OSDManager::Window_Show
13:18:03.419 - OSDManager::Window_Show
13:18:03.431 - OSDManager::Window_Show
13:18:03.474 - OK. 102
13:18:03.506 - Api2BaseModule.EngineApi_ChList_SendSubChannels 0/2
13:18:03.585 - 
13:18:03.587 -        #################### First traffic. (0.516ms) #######################
13:18:03.590 - 
13:18:03.593 - TransportMarker: TS
13:18:03.594 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:03.596 - --SwitchEngineTransport TS > TS
13:18:03.599 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:03.601 - PreScanner.OnTransportMarker TS
13:18:03.603 - --SwitchEngineTransport end
13:18:03.612 - PlayTimePATParser.EndTask
13:18:03.687 - OSDManager::Window_Show
13:18:03.698 - PreScanner.OnAfterScanPat count=2 {1;4096}
13:18:03.700 - Api2BaseModule.Filters_EnabledFullTS 0
13:18:03.704 - GraphState: RequestPMTScan by OnAfterScanPat
13:18:03.706 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=1
13:18:03.708 - Open TSTS filter pid=4096 data=2
13:18:03.710 - TSTS cur size=1101492
13:18:03.712 - TSTS quick finish
13:18:03.714 - PreScanner.OnAfterScanPmt pmt=4096
13:18:03.716 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
13:18:03.718 - PlayTimePmtParser::StopParser
13:18:03.735 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
13:18:03.737 - TimeShift.Cursor SetChannel::v 1297012 (1297012)
13:18:03.739 - Prereader.SetChannel unmask 1
13:18:03.741 - Plugin::SetChannel 1
13:18:03.743 - TransponderManager::SelectChannel
13:18:03.746 - TsInputTrafficProcessor.SelectChannel 1
13:18:03.747 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:03.750 - TsInputTrafficProcessor.UpdateChannel 1
13:18:03.752 - PreScanner.StartChannelIsReady net=1 parseall=0
13:18:03.754 - LngDefaultSelector.try select audio pid=257 type=1 lng=7498613-ukr(deu,deu,rus) l=99
13:18:03.758 - ChannelGraph5::AfterDetectChannelParams
13:18:03.761 - VideoMediaTypeDetection: h.264
13:18:03.763 - SimpleTsDemux::Init apid=257, vpid=256
13:18:03.766 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
13:18:03.768 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
13:18:03.770 - Prereader::ReaderCursor.. OK
13:18:03.773 - ReaderCursor::SetPosition 0 (w=1606272)
13:18:03.775 - Prereader.StartPlayback Push buffering=0 recv=000002846B2E5DF8 [StartChannelHelperBase(sl)]
13:18:03.778 - Prereader.StartPlayback after lock
13:18:03.781 - PreScanner.StartPmtParserIfNeed
13:18:03.783 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=0
13:18:03.781 - VideoParser::First packet 7878 h.264
13:18:03.785 - Open TSTS filter pid=4096 data=2
13:18:03.787 - VideoParser::packet 9778
13:18:03.789 - TSTS cur size=1816268
13:18:03.791 - VideoParser::packet 10333
13:18:03.795 - VideoParser::packet 10916
13:18:03.798 - VideoParser::packet 11465
13:18:03.800 - AudioParser::First packet 2070
13:18:03.803 - AudioParser::AAC detected
13:18:03.805 - VideoParser::packet 12049
13:18:03.808 - VideoParser::packet 18400
13:18:03.810 - * s:100 q:100 tr=2043372 (0) Preparing
13:18:03.811 - VideoParser::packet 23573
13:18:03.815 - VideoParser::packet 24436
13:18:03.818 - VideoParser::packet 25297
13:18:03.820 - VideoParser::packet 26102
13:18:03.823 - VideoParser::packet 26937
13:18:03.827 - VideoParser::packet 37251
13:18:03.827 - VideoParser::packet 44708
13:18:03.829 - VideoParser::packet 45897
13:18:03.834 - VideoParser::packet 47064
13:18:03.836 - VideoParser::packet 48314
13:18:03.838 - VideoParser::packet 49563
13:18:03.840 - VideoParser::packet 67423
13:18:03.843 - VideoParser::packet 76459
13:18:03.846 - VideoParser::packet 78114
13:18:03.849 - VideoParser::packet 79767
13:18:03.852 - VideoParser::packet 81426
13:18:03.854 - VideoParser::packet 83046
13:18:03.857 - VideoParser::packet 102739
13:18:03.859 - VideoParser::packet 108295
13:18:03.862 - VideoParser::packet 109591
13:18:03.865 - VideoParser::packet 110897
13:18:03.868 - VideoParser::packet 112406
13:18:03.870 - VideoParser::packet 114020
13:18:03.873 - VideoParser::packet 133638
13:18:03.876 - VideoParser::packet 140773
13:18:03.879 - VideoParser::packet 142547
13:18:03.881 - VideoParser::packet 144361
13:18:03.884 - VideoParser::packet 146479
13:18:03.886 - VideoParser::packet 148528
13:18:03.889 - VideoParser::packet 166886
13:18:03.891 - VideoParser::packet 171091
13:18:03.894 - VideoParser::packet 173739
13:18:03.897 - VideoParser::packet 176205
13:18:03.900 - VideoParser::packet 178803
13:18:03.903 - VideoParser::packet 181277
13:18:03.905 - VideoParser::packet 200166
13:18:03.908 - VideoParser::packet 205102
13:18:03.912 - VideoParser::packet 207685
13:18:03.915 - VideoParser::packet 210276
13:18:03.917 - VideoParser::packet 240047
13:18:03.920 - h264 detected 141 ms
13:18:03.922 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
13:18:03.925 - PreScanner.Post_InitRender [ReceiveTraffic]
13:18:03.932 - [102]sm: TvInitRenderer 1
13:18:03.935 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
13:18:03.937 - CalculBufferingSize prov=00000284683A14F4 marker=1 request=1
13:18:03.940 - CalculBuffering 2000ms br=2769kb to 692 kbytes. from marker
13:18:03.942 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
13:18:03.945 - Prereader::ReaderCursor.. OK
13:18:03.950 - ReaderCursor::SetPosition 0 (w=3307672)
13:18:03.952 - Prereader.StartPlayback Pull buffering=709000 recv=0000000000000000 [EnablePullModeAndStartPlayback]
13:18:03.954 - Prereader.StartPlayback after lock
13:18:03.956 - Buffering/prereader size 692/3906 kbytes
13:18:03.959 - ------sGetVideoParams
13:18:03.962 - ChannelGraph5.CreateInterfacesAndRenderGraph
13:18:03.959 - OnBuffering.OnTunerStateChanged  0
13:18:03.967 - subsm.StartChannel demux=ProgDemux tr=TS
13:18:03.969 - subsm.RecreateSubtitlesParsers 00000284682D3080 ts=1 subindex=-1
13:18:03.972 - subsm.Set Teletext parser 0
13:18:03.974 - subsm.RecreateSubtitlesParsers end
13:18:03.976 - subs: OnSetChannel
13:18:03.978 - CreateCustomGraph
13:18:03.981 - VideoType:H.264/AVC ffmpeg=0
13:18:03.983 - Video/4.H264 : MPEG2_VIDEO s={0,0,720,576}, t={0,0,720,576}, bmp=720x576, r=16/9, br=0,frametime=40ms, IF=0x0, CF=0x0)
13:18:03.985 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
13:18:04.012 - OK
13:18:04.014 - CChannelGraph5::CreateRender 10
13:18:04.016 - VR: EVR Custom
13:18:04.018 - VR: create new render
13:18:04.059 - VR: Add video renderer Video Renderer - OK
13:18:04.061 - CreateAudioPartOfGraph
13:18:04.064 - AudioType:AAC/ADTS 
13:18:04.066 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
13:18:04.068 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
13:18:04.077 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
13:18:04.079 - Added audio renderer
13:18:04.081 - AP: created
13:18:04.083 - Added audio processor
13:18:04.093 - Connect codec to AP - OK
13:18:04.115 - Add and connect audio renderer - OK
13:18:04.117 - Graph::AfterRender
13:18:04.119 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
13:18:04.121 - AV:UpdateAudioParamsAfterActive
13:18:04.123 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:18:04.124 - GR:UpdateAudioProcessor old=1 new=0
13:18:04.126 - Destroy Audio Processor udate
13:18:04.129 - Graph::SetVolume 5% -5402db
13:18:04.131 - Graph::SetAudioChannelMask
13:18:04.133 - Graph::Run
13:18:04.196 - Graph::Run 1
13:18:04.200 - Graph::SetPictureParams
13:18:04.202 - Graph::SetVideoRect {8 8 712 568}
13:18:04.204 - Graph::SetVideoWindowRect {0 0 919 516}
13:18:04.294 - 
13:18:04.297 - [0]########################### Mark of finish channel changing. (1.219ms) #############
13:18:04.299 - 
13:18:04.318 - CChannelGraph5::HideSubtitles
13:18:04.744 - * s:100 q:100 tr=1415828 (0) Playing
13:18:04.888 - 
13:18:04.890 - [0]########################### First video frame. (1.813ms) #############
13:18:04.892 - 
13:18:05.745 - * s:100 q:100 tr=1168420 (0) Playing
13:18:06.750 - * s:100 q:100 tr=0 (0) Playing
13:18:07.751 - * s:100 q:100 tr=283128 (0) Playing
13:18:08.747 - * s:100 q:100 tr=925524 (0) Playing
13:18:08.923 - OSDManager::Window_Show
13:18:08.954 - OSDManager::Window_Delete
13:18:09.920 - * s:100 q:100 tr=0 (0) Playing
13:18:10.918 - * s:100 q:100 tr=0 (0) Playing
13:18:11.917 - * s:100 q:100 tr=0 (0) Playing
13:18:12.916 - * s:100 q:100 tr=1163720 (0) Playing
13:18:13.924 - * s:100 q:100 tr=0 (0) Playing
13:18:14.923 - * s:100 q:100 tr=1171804 (0) Playing
13:18:15.924 - * s:100 q:100 tr=0 (0) Playing
13:18:16.211 - ModuleList::Module_GetList 2
13:18:16.919 - * s:100 q:100 tr=0 (0) Playing
13:18:17.919 - * s:100 q:100 tr=0 (0) Playing
13:18:18.919 - * s:100 q:100 tr=0 (0) Playing
13:18:19.915 - * s:0 q:0 tr=0 (0) Playing
13:18:20.918 - * s:100 q:100 tr=1243244 (0) Playing
13:18:21.917 - * s:100 q:100 tr=0 (0) Playing
13:18:22.648 - 
13:18:22.650 - 
13:18:22.652 - ########################### Mark of start channel changing.###########################
13:18:22.654 - 
13:18:22.656 - GraphManager::MainChangeChannel Футбол 1  1 provs
13:18:22.658 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
13:18:22.660 - SetChannelLogic::SetChannel 0
13:18:22.663 - SetChannelLogic::SetNormalChannel
13:18:22.668 - ChannelGraph5::StopChannel Футбол 1
13:18:22.671 - PreScanner.Stop
13:18:22.673 - GraphState: Undef by PreScanner.Stop
13:18:22.676 - PlayTimePmtParser::StopParser
13:18:22.679 - TimeShift.Cursor PushMode 0 0 (pos=0) [Engine5ChannelBase.StopChannel]
13:18:22.681 - Prereader::ReaderCursor.. OK
13:18:22.684 - ReaderCursor::SetPosition 0 (w=10515216)
13:18:22.686 - Prereader.StartPlayback Disable buffering=0 recv=0000000000000000 [Engine5ChannelBase.StopChannel]
13:18:22.688 - Prereader.StartPlayback after lock
13:18:22.690 - subsm.StopChannel
13:18:22.693 - Graph::Stop
13:18:22.726 - Before Stop ...13:18:22.730 - OnGraphStop ...13:18:22.745 - VR: Disconnect
13:18:22.769 - Graph::ReleaseAllFilters
13:18:22.771 - release: Prog Audio renderer - RR - OK.
13:18:22.778 - release: Video Renderer - RR - OK.
13:18:22.794 - release: Video decoder  - RR - OK.
13:18:22.803 - release: Audio Processor - RR - OK.
13:18:22.807 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
13:18:22.812 - FilterGraph: 1
13:18:22.814 - 
13:18:22.816 - TransponderManager::SetTransponder (CH) 0 Футбол 1
13:18:22.818 - *Transport TS
13:18:22.820 - Api2Device::SetChannel http://hls2.lan.ua:8123/index.m3u8
13:18:22.833 - Api2BaseModule.OnTunerStateChanged Connecting
13:18:22.833 - Api2Device::SetChannel result OK
13:18:22.835 - Api2BaseModule.OnTunerStateChanged  -3
13:18:22.837 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=1
13:18:22.842 - TsInputTrafficProcessor.OpenTransponder 1
13:18:22.847 - FilterManager::OnSetTransponder SetChannel
13:18:22.850 - TimeShift.Reset
13:18:22.852 - TimeShift.Cursor reset
13:18:22.854 - ReaderCursor::Reset.. OK
13:18:22.850 - Api2BaseModule.OnTunerStateChanged Preparing
13:18:22.859 - Prereader.Reset ...13:18:22.861 - Api2BaseModule.OnTunerStateChanged  -4
-OK
13:18:22.868 - ModuleList::ChangeChannel 0
13:18:22.870 - [102]ChannelGraph5::StartChannel Футбол 1
13:18:22.872 - Api2BaseModule.OnTunerStateChanged Playing
13:18:22.872 - 
13:18:22.874 - Api2BaseModule.OnTunerStateChanged  -4
13:18:22.876 - [102]       #################### Start stream. (0.219ms) #######################
13:18:22.881 - 
13:18:22.900 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
13:18:22.901 - TimeShift.Cursor SetChannel::v 0 (0)
13:18:22.903 - ReaderCursor::SetChannel.. OK
13:18:22.907 - ReaderCursor::SetPosition 0 (w=0)
13:18:22.909 - Prereader.SetChannel..
13:18:22.912 - Prereader.SetChannel unmask 1
13:18:22.914 - Plugin::SetChannel 1
13:18:22.917 - TransponderManager::SelectChannel
13:18:22.919 - TsInputTrafficProcessor.SelectChannel 1
13:18:22.921 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:22.923 - TsInputTrafficProcessor.UpdateChannel 1
13:18:22.925 - GraphState: Undef by StartChannelIsReady
13:18:22.927 - PreScanner.StartChannelIsReady net=1 parseall=1
13:18:22.929 - VideoMediaTypeDetection: h.264
13:18:22.932 - SetMarkerAudioLngStream Gen New stream
13:18:22.934 - SimpleTsDemux::Init apid=257, vpid=256
13:18:22.936 - GraphState: RequestPATScan by StartChannelIsReady TS
13:18:22.938 - Api2BaseModule.Filters_EnabledFullTS 1
13:18:22.940 - PlayTimePATParser.OpenParser 1
13:18:22.942 - Open TSTS filter pid=0 data=0
13:18:22.945 - TSTS cur size=0
13:18:22.947 - Graph::UpdateRenderMode
13:18:23.008 - Graph::SetVideoRect {8 8 712 568}
13:18:23.011 - Graph::SetVideoWindowRect {0 0 919 516}
13:18:23.014 - [102]OnChangeCurrentGraph2 -endOfSetChannel
13:18:23.016 - ChannelGraph5.SetActiveState 1
13:18:23.068 - OSDManager::Window_Add
13:18:23.072 - OSDManager::Window_Show
13:18:23.090 - * s:0 q:0 tr=0 (0) Preparing
13:18:23.109 - OSDManager::Window_Show
13:18:23.114 - OSDManager::Window_Show
13:18:23.192 - OK. 102
13:18:23.231 - Api2BaseModule.EngineApi_ChList_SendSubChannels 0/2
13:18:23.323 - TransportMarker: TS
13:18:23.325 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:23.328 - 
13:18:23.328 - --SwitchEngineTransport TS > TS
13:18:23.331 -        #################### First traffic. (0.672ms) #######################
13:18:23.335 - 
13:18:23.337 - PlayTimePATParser.EndTask
13:18:23.339 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:23.341 - PreScanner.OnTransportMarker TS
13:18:23.343 - --SwitchEngineTransport end
13:18:23.346 - PreScanner.OnAfterScanPat count=2 {1;4096}
13:18:23.348 - Api2BaseModule.Filters_EnabledFullTS 0
13:18:23.351 - GraphState: RequestPMTScan by OnAfterScanPat
13:18:23.354 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=1
13:18:23.356 - Open TSTS filter pid=4096 data=2
13:18:23.358 - TSTS cur size=376376
13:18:23.360 - TSTS quick finish
13:18:23.380 - OSDManager::Window_Show
13:18:23.391 - PreScanner.OnAfterScanPmt pmt=4096
13:18:23.393 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
13:18:23.396 - PlayTimePmtParser::StopParser
13:18:23.413 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
13:18:23.416 - TimeShift.Cursor SetChannel::v 920636 (920636)
13:18:23.418 - Prereader.SetChannel unmask 1
13:18:23.420 - Plugin::SetChannel 1
13:18:23.422 - TransponderManager::SelectChannel
13:18:23.424 - TsInputTrafficProcessor.SelectChannel 1
13:18:23.427 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:23.430 - TsInputTrafficProcessor.UpdateChannel 1
13:18:23.433 - PreScanner.StartChannelIsReady net=1 parseall=0
13:18:23.435 - LngDefaultSelector.try select audio pid=257 type=1 lng=7498613-ukr(deu,deu,rus) l=99
13:18:23.437 - ChannelGraph5::AfterDetectChannelParams
13:18:23.439 - VideoMediaTypeDetection: h.264
13:18:23.442 - SimpleTsDemux::Init apid=257, vpid=256
13:18:23.444 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
13:18:23.446 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
13:18:23.448 - Prereader::ReaderCursor.. OK
13:18:23.452 - ReaderCursor::SetPosition 0 (w=1350968)
13:18:23.454 - Prereader.StartPlayback Push buffering=0 recv=000002846B2E5DF8 [StartChannelHelperBase(sl)]
13:18:23.456 - Prereader.StartPlayback after lock
13:18:23.458 - PreScanner.StartPmtParserIfNeed
13:18:23.459 - VideoParser::First packet 62047 h.264
13:18:23.461 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=0
13:18:23.464 - h264 detected 0 ms
13:18:23.466 - Open TSTS filter pid=4096 data=2
13:18:23.468 - AudioParser::First packet 2035
13:18:23.470 - TSTS cur size=1568484
13:18:23.472 - AudioParser::AAC detected
13:18:23.477 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
13:18:23.480 - PreScanner.Post_InitRender [ReceiveTraffic]
13:18:23.487 - [102]sm: TvInitRenderer 1
13:18:23.489 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
13:18:23.491 - CalculBufferingSize prov=00000284683A14F4 marker=1 request=1
13:18:23.493 - CalculBuffering 2000ms br=4243kb to 1060 kbytes. from marker
13:18:23.495 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
13:18:23.497 - Prereader::ReaderCursor.. OK
13:18:23.501 - ReaderCursor::SetPosition 0 (w=1641428)
13:18:23.503 - Prereader.StartPlayback Pull buffering=1086250 recv=0000000000000000 [EnablePullModeAndStartPlayback]
13:18:23.505 - Prereader.StartPlayback after lock
13:18:23.507 - Buffering/prereader size 1060/3906 kbytes
13:18:23.509 - ------sGetVideoParams
13:18:23.512 - ChannelGraph5.CreateInterfacesAndRenderGraph
13:18:23.512 - * s:100 q:100 tr=1642556 (0) Preparing
13:18:23.516 - OnBuffering.OnTunerStateChanged  4
13:18:23.516 - subsm.StartChannel demux=ProgDemux tr=TS
13:18:23.520 - subsm.RecreateSubtitlesParsers 00000284682D3080 ts=1 subindex=-1
13:18:23.523 - subsm.Set Teletext parser 0
13:18:23.525 - subsm.RecreateSubtitlesParsers end
13:18:23.526 - subs: OnSetChannel
13:18:23.529 - CreateCustomGraph
13:18:23.531 - VideoType:H.264/AVC ffmpeg=0
13:18:23.533 - Video/4.H264 : MPEG2_VIDEO s={0,0,720,576}, t={0,0,720,576}, bmp=720x576, r=254/139, br=0,frametime=40ms, IF=0x0, CF=0x0)
13:18:23.535 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
13:18:23.561 - OK
13:18:23.563 - CChannelGraph5::CreateRender 10
13:18:23.565 - VR: EVR Custom
13:18:23.567 - VR: create new render
13:18:23.614 - VR: Add video renderer Video Renderer - OK
13:18:23.616 - CreateAudioPartOfGraph
13:18:23.618 - AudioType:AAC/ADTS 
13:18:23.620 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
13:18:23.623 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
13:18:23.632 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
13:18:23.634 - Added audio renderer
13:18:23.636 - AP: created
13:18:23.638 - Added audio processor
13:18:23.649 - Connect codec to AP - OK
13:18:23.667 - Add and connect audio renderer - OK
13:18:23.669 - Graph::AfterRender
13:18:23.670 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
13:18:23.672 - AV:UpdateAudioParamsAfterActive
13:18:23.674 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:18:23.676 - GR:UpdateAudioProcessor old=1 new=0
13:18:23.677 - Destroy Audio Processor udate
13:18:23.680 - Graph::SetVolume 5% -5402db
13:18:23.683 - Graph::SetAudioChannelMask
13:18:23.685 - Graph::Run
13:18:23.733 - Graph::Run 1
13:18:23.739 - Graph::SetPictureParams
13:18:23.741 - Graph::SetVideoRect {8 8 712 568}
13:18:23.743 - Graph::SetVideoWindowRect {0 7 919 509}
13:18:23.780 - OnBuffering.OnTunerStateChanged  0
13:18:23.797 - CChannelGraph5::HideSubtitles
13:18:23.819 - 
13:18:23.821 - [0]########################### Mark of finish channel changing. (1.172ms) #############
13:18:23.823 - 
13:18:23.895 - OnBuffering.OnTunerStateChanged  0
13:18:23.983 - 
13:18:23.986 - [0]########################### First video frame. (1.329ms) #############
13:18:23.989 - 
13:18:24.030 - * s:100 q:100 tr=2243968 (0) Playing
13:18:24.918 - * s:100 q:100 tr=3100308 (0) Playing
13:18:25.918 - * s:100 q:100 tr=0 (0) Playing
13:18:26.914 - 
13:18:26.916 - 
13:18:26.919 - ########################### Mark of start channel changing.###########################
13:18:26.921 - 
13:18:26.922 - GraphManager::MainChangeChannel Футбол 2  1 provs
13:18:26.924 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
13:18:26.926 - SetChannelLogic::SetChannel 0
13:18:26.928 - SetChannelLogic::SetNormalChannel
13:18:26.935 - ChannelGraph5::StopChannel Футбол 2
13:18:26.937 - PreScanner.Stop
13:18:26.939 - GraphState: Undef by PreScanner.Stop
13:18:26.942 - PlayTimePmtParser::StopParser
13:18:26.944 - TimeShift.Cursor PushMode 0 0 (pos=0) [Engine5ChannelBase.StopChannel]
13:18:26.946 - Prereader::ReaderCursor.. OK
13:18:26.951 - ReaderCursor::SetPosition 0 (w=6982132)
13:18:26.953 - Prereader.StartPlayback Disable buffering=0 recv=0000000000000000 [Engine5ChannelBase.StopChannel]
13:18:26.955 - Prereader.StartPlayback after lock
13:18:26.957 - subsm.StopChannel
13:18:26.959 - Graph::Stop
13:18:26.991 - Before Stop ...13:18:26.994 - OnGraphStop ...13:18:27.010 - VR: Disconnect
13:18:27.036 - Graph::ReleaseAllFilters
13:18:27.038 - release: Prog Audio renderer - RR - OK.
13:18:27.045 - release: Video Renderer - RR - OK.
13:18:27.061 - release: Video decoder  - RR - OK.
13:18:27.071 - release: Audio Processor - RR - OK.
13:18:27.075 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
13:18:27.078 - FilterGraph: 1
13:18:27.083 - 
13:18:27.085 - TransponderManager::SetTransponder (CH) 0 Футбол 2
13:18:27.087 - *Transport TS
13:18:27.089 - Api2Device::SetChannel http://hls2.lan.ua:8156/index.m3u8
13:18:27.104 - Api2BaseModule.OnTunerStateChanged Connecting
13:18:27.104 - Api2Device::SetChannel result OK
13:18:27.106 - Api2BaseModule.OnTunerStateChanged  -3
13:18:27.108 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=1
13:18:27.112 - TsInputTrafficProcessor.OpenTransponder 1
13:18:27.112 - FilterManager::OnSetTransponder SetChannel
13:18:27.116 - TimeShift.Reset
13:18:27.118 - TimeShift.Cursor reset
13:18:27.120 - ReaderCursor::Reset.. OK
13:18:27.120 - Api2BaseModule.OnTunerStateChanged Preparing
13:18:27.124 - Prereader.Reset ...13:18:27.126 - Api2BaseModule.OnTunerStateChanged  -4
-OK
13:18:27.132 - ModuleList::ChangeChannel 0
13:18:27.134 - [102]ChannelGraph5::StartChannel Футбол 2
13:18:27.135 - Api2BaseModule.OnTunerStateChanged Playing
13:18:27.135 - 
13:18:27.137 - Api2BaseModule.OnTunerStateChanged  -4
13:18:27.139 - [102]       #################### Start stream. (0.219ms) #######################
13:18:27.143 - 
13:18:27.165 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
13:18:27.167 - TimeShift.Cursor SetChannel::v 0 (0)
13:18:27.169 - ReaderCursor::SetChannel.. OK
13:18:27.172 - ReaderCursor::SetPosition 0 (w=0)
13:18:27.174 - Prereader.SetChannel..
13:18:27.176 - Prereader.SetChannel unmask 1
13:18:27.178 - Plugin::SetChannel 1
13:18:27.180 - TransponderManager::SelectChannel
13:18:27.182 - TsInputTrafficProcessor.SelectChannel 1
13:18:27.184 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:27.187 - TsInputTrafficProcessor.UpdateChannel 1
13:18:27.189 - GraphState: Undef by StartChannelIsReady
13:18:27.191 - PreScanner.StartChannelIsReady net=1 parseall=1
13:18:27.192 - VideoMediaTypeDetection: h.264
13:18:27.194 - SetMarkerAudioLngStream Gen New stream
13:18:27.197 - SimpleTsDemux::Init apid=257, vpid=256
13:18:27.199 - GraphState: RequestPATScan by StartChannelIsReady TS
13:18:27.201 - Api2BaseModule.Filters_EnabledFullTS 1
13:18:27.204 - PlayTimePATParser.OpenParser 1
13:18:27.205 - Open TSTS filter pid=0 data=0
13:18:27.207 - TSTS cur size=0
13:18:27.209 - Graph::UpdateRenderMode
13:18:27.239 - Graph::SetVideoRect {8 8 712 568}
13:18:27.241 - Graph::SetVideoWindowRect {0 7 919 509}
13:18:27.243 - [102]OnChangeCurrentGraph2 -endOfSetChannel
13:18:27.245 - ChannelGraph5.SetActiveState 1
13:18:27.269 - OSDManager::Window_Show
13:18:27.283 - OSDManager::Window_Show
13:18:27.294 - OSDManager::Window_Show
13:18:27.351 - OK. 102
13:18:27.393 - Api2BaseModule.EngineApi_ChList_SendSubChannels 0/2
13:18:27.453 - * s:0 q:0 tr=0 (0) Preparing
13:18:27.475 - 
13:18:27.477 -        #################### First traffic. (0.563ms) #######################
13:18:27.479 - 
13:18:27.481 - PlayTimePATParser.EndTask
13:18:27.484 - TransportMarker: TS
13:18:27.486 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:27.523 - PreScanner.OnAfterScanPat count=2 {1;4096}
13:18:27.525 - Api2BaseModule.Filters_EnabledFullTS 0
13:18:27.529 - GraphState: RequestPMTScan by OnAfterScanPat
13:18:27.531 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=1
13:18:27.533 - Open TSTS filter pid=4096 data=2
13:18:27.535 - TSTS cur size=720604
13:18:27.537 - TSTS quick finish
13:18:27.539 - --SwitchEngineTransport TS > TS
13:18:27.541 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:27.543 - PreScanner.OnTransportMarker TS
13:18:27.545 - --SwitchEngineTransport end
13:18:27.546 - PreScanner.OnAfterScanPmt pmt=4096
13:18:27.549 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
13:18:27.551 - PlayTimePmtParser::StopParser
13:18:27.571 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
13:18:27.573 - TimeShift.Cursor SetChannel::v 1203576 (1203576)
13:18:27.575 - Prereader.SetChannel unmask 1
13:18:27.577 - Plugin::SetChannel 1
13:18:27.579 - TransponderManager::SelectChannel
13:18:27.581 - TsInputTrafficProcessor.SelectChannel 1
13:18:27.583 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:27.586 - TsInputTrafficProcessor.UpdateChannel 1
13:18:27.588 - PreScanner.StartChannelIsReady net=1 parseall=0
13:18:27.590 - LngDefaultSelector.try select audio pid=257 type=1 lng=7498613-ukr(deu,deu,rus) l=99
13:18:27.592 - ChannelGraph5::AfterDetectChannelParams
13:18:27.594 - VideoMediaTypeDetection: h.264
13:18:27.596 - SimpleTsDemux::Init apid=257, vpid=256
13:18:27.596 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
13:18:27.601 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
13:18:27.603 - Prereader::ReaderCursor.. OK
13:18:27.608 - ReaderCursor::SetPosition 0 (w=1647256)
13:18:27.610 - Prereader.StartPlayback Push buffering=0 recv=000002846B2E5DF8 [StartChannelHelperBase(sl)]
13:18:27.612 - Prereader.StartPlayback after lock
13:18:27.614 - PreScanner.StartPmtParserIfNeed
13:18:27.614 - VideoParser::First packet 28993 h.264
13:18:27.616 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=0
13:18:27.619 - VideoParser::packet 49614
13:18:27.620 - Open TSTS filter pid=4096 data=2
13:18:27.622 - VideoParser::packet 59198
13:18:27.624 - TSTS cur size=1794460
13:18:27.626 - VideoParser::packet 67109
13:18:27.630 - VideoParser::packet 71885
13:18:27.632 - AudioParser::First packet 1943
13:18:27.639 - AudioParser::AAC detected
13:18:27.641 - VideoParser::packet 76476
13:18:27.643 - VideoParser::packet 89016
13:18:27.645 - VideoParser::packet 101698
13:18:27.647 - VideoParser::packet 121763
13:18:27.650 - VideoParser::packet 137068
13:18:27.652 - VideoParser::packet 144734
13:18:27.654 - VideoParser::packet 151562
13:18:27.657 - VideoParser::packet 157144
13:18:27.657 - OSDManager::Window_Show
13:18:27.657 - VideoParser::packet 162768
13:18:27.663 - VideoParser::packet 167588
13:18:27.665 - VideoParser::packet 172458
13:18:27.669 - VideoParser::packet 189986
13:18:27.672 - VideoParser::packet 201560
13:18:27.674 - VideoParser::packet 207102
13:18:27.676 - VideoParser::packet 211889
13:18:27.679 - VideoParser::packet 217856
13:18:27.681 - VideoParser::packet 224140
13:18:27.683 - VideoParser::packet 226938
13:18:27.686 - VideoParser::packet 229937
13:18:27.688 - VideoParser::packet 255453
13:18:27.690 - VideoParser::packet 263638
13:18:27.693 - VideoParser::packet 278308
13:18:27.695 - VideoParser::packet 287816
13:18:27.698 - VideoParser::packet 296702
13:18:27.701 - VideoParser::packet 305883
13:18:27.703 - VideoParser::packet 315507
13:18:27.705 - VideoParser::packet 325763
13:18:27.708 - VideoParser::packet 346230
13:18:27.710 - VideoParser::packet 351425
13:18:27.712 - VideoParser::packet 365976
13:18:27.715 - VideoParser::packet 370931
13:18:27.718 - VideoParser::packet 380088
13:18:27.720 - VideoParser::packet 389689
13:18:27.722 - VideoParser::packet 400177
13:18:27.725 - VideoParser::packet 410873
13:18:27.727 - VideoParser::packet 431285
13:18:27.730 - VideoParser::packet 435347
13:18:27.732 - VideoParser::packet 450609
13:18:27.734 - VideoParser::packet 455142
13:18:27.737 - VideoParser::packet 465719
13:18:27.739 - VideoParser::packet 476414
13:18:27.742 - VideoParser::packet 482441
13:18:27.744 - VideoParser::packet 488764
13:18:27.747 - VideoParser::packet 511911
13:18:27.750 - VideoParser::packet 518700
13:18:27.752 - VideoParser::packet 530078
13:18:27.755 - VideoParser::packet 533661
13:18:27.757 - VideoParser::packet 542478
13:18:27.760 - VideoParser::packet 551168
13:18:27.762 - VideoParser::packet 555464
13:18:27.765 - VideoParser::packet 559761
13:18:27.768 - VideoParser::packet 581776
13:18:27.771 - h264 detected 141 ms
13:18:27.773 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
13:18:27.774 - PreScanner.Post_InitRender [ReceiveTraffic]
13:18:27.776 - [102]sm: TvInitRenderer 1
13:18:27.779 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
13:18:27.781 - CalculBufferingSize prov=00000284683A14F4 marker=1 request=1
13:18:27.783 - CalculBuffering 2000ms br=4333kb to 1083 kbytes. from marker
13:18:27.785 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
13:18:27.788 - Prereader::ReaderCursor.. OK
13:18:27.793 - ReaderCursor::SetPosition 0 (w=3478564)
13:18:27.795 - Prereader.StartPlayback Pull buffering=1109250 recv=0000000000000000 [EnablePullModeAndStartPlayback]
13:18:27.798 - Prereader.StartPlayback after lock
13:18:27.800 - Buffering/prereader size 1083/3906 kbytes
13:18:27.802 - ------sGetVideoParams
13:18:27.804 - ChannelGraph5.CreateInterfacesAndRenderGraph
13:18:27.804 - * s:100 q:100 tr=3481008 (0) Preparing
13:18:27.807 - OnBuffering.OnTunerStateChanged  4
13:18:27.808 - subsm.StartChannel demux=ProgDemux tr=TS
13:18:27.812 - subsm.RecreateSubtitlesParsers 00000284682D3080 ts=1 subindex=-1
13:18:27.814 - subsm.Set Teletext parser 0
13:18:27.816 - subsm.RecreateSubtitlesParsers end
13:18:27.819 - subs: OnSetChannel
13:18:27.821 - CreateCustomGraph
13:18:27.824 - VideoType:H.264/AVC ffmpeg=0
13:18:27.826 - Video/4.H264 : MPEG2_VIDEO s={0,0,720,576}, t={0,0,720,576}, bmp=720x576, r=254/139, br=0,frametime=40ms, IF=0x0, CF=0x0)
13:18:27.829 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
13:18:27.862 - OK
13:18:27.864 - CChannelGraph5::CreateRender 10
13:18:27.867 - VR: EVR Custom
13:18:27.870 - VR: create new render
13:18:27.928 - VR: Add video renderer Video Renderer - OK
13:18:27.930 - CreateAudioPartOfGraph
13:18:27.933 - AudioType:AAC/ADTS 
13:18:27.935 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
13:18:27.939 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
13:18:27.949 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
13:18:27.951 - Added audio renderer
13:18:27.954 - AP: created
13:18:27.956 - Added audio processor
13:18:27.968 - Connect codec to AP - OK
13:18:27.985 - Add and connect audio renderer - OK
13:18:27.987 - Graph::AfterRender
13:18:27.989 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
13:18:27.992 - AV:UpdateAudioParamsAfterActive
13:18:27.994 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:18:27.996 - GR:UpdateAudioProcessor old=1 new=0
13:18:27.998 - Destroy Audio Processor udate
13:18:28.000 - Graph::SetVolume 5% -5402db
13:18:28.003 - Graph::SetAudioChannelMask
13:18:28.005 - Graph::Run
13:18:28.057 - Graph::Run 1
13:18:28.062 - Graph::SetPictureParams
13:18:28.064 - Graph::SetVideoRect {8 8 712 568}
13:18:28.067 - Graph::SetVideoWindowRect {0 7 919 509}
13:18:28.121 - 
13:18:28.123 - [0]########################### Mark of finish channel changing. (1.203ms) #############
13:18:28.125 - 
13:18:28.140 - CChannelGraph5::HideSubtitles
13:18:28.922 - * s:100 q:100 tr=3629528 (0) Playing
13:18:29.149 - 
13:18:29.151 - [0]########################### First video frame. (2.234ms) #############
13:18:29.153 - 
13:18:29.918 - * s:100 q:100 tr=1717944 (0) Playing
13:18:30.920 - * s:100 q:100 tr=0 (0) Playing
13:18:31.922 - * s:100 q:100 tr=1738436 (0) Playing
13:18:32.917 - OSDManager::Window_Show
13:18:32.939 - OSDManager::Window_Delete
13:18:32.976 - * s:100 q:100 tr=0 (0) Playing
13:18:33.924 - * s:100 q:100 tr=0 (0) Playing
13:18:34.918 - * s:100 q:100 tr=0 (0) Playing
13:18:35.923 - * s:100 q:100 tr=0 (0) Playing
13:18:36.916 - * s:100 q:100 tr=1817396 (0) Playing
13:18:37.916 - * s:100 q:100 tr=0 (0) Playing
13:18:38.088 - 
13:18:38.090 - 
13:18:38.092 - ########################### Mark of start channel changing.###########################
13:18:38.094 - 
13:18:38.096 - GraphManager::MainChangeChannel Черноморская ТРК  1 provs
13:18:38.097 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
13:18:38.100 - SetChannelLogic::SetChannel 0
13:18:38.102 - SetChannelLogic::SetNormalChannel
13:18:38.109 - ChannelGraph5::StopChannel Черноморская ТРК
13:18:38.111 - PreScanner.Stop
13:18:38.112 - GraphState: Undef by PreScanner.Stop
13:18:38.115 - PlayTimePmtParser::StopParser
13:18:38.117 - TimeShift.Cursor PushMode 0 0 (pos=0) [Engine5ChannelBase.StopChannel]
13:18:38.119 - Prereader::ReaderCursor.. OK
13:18:38.123 - ReaderCursor::SetPosition 0 (w=12376228)
13:18:38.126 - Prereader.StartPlayback Disable buffering=0 recv=0000000000000000 [Engine5ChannelBase.StopChannel]
13:18:38.128 - Prereader.StartPlayback after lock
13:18:38.130 - subsm.StopChannel
13:18:38.131 - Graph::Stop
13:18:38.164 - Before Stop ...13:18:38.168 - OnGraphStop ...13:18:38.184 - VR: Disconnect
13:18:38.211 - Graph::ReleaseAllFilters
13:18:38.213 - release: Prog Audio renderer - RR - OK.
13:18:38.222 - release: Video Renderer - RR - OK.
13:18:38.240 - release: Video decoder  - RR - OK.
13:18:38.249 - release: Audio Processor - RR - OK.
13:18:38.253 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
13:18:38.257 - FilterGraph: 1
13:18:38.262 - 
13:18:38.264 - TransponderManager::SetTransponder (CH) 0 Черноморская ТРК
13:18:38.266 - *Transport TS
13:18:38.268 - Api2Device::SetChannel http://hls2.lan.ua:8066/index.m3u8
13:18:38.281 - skip old generation traffic!
13:18:38.284 - Api2BaseModule.OnTunerStateChanged Connecting
13:18:38.287 - Api2BaseModule.OnTunerStateChanged  -3
13:18:38.293 - Api2Device::SetChannel result OK
13:18:38.296 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=43981
13:18:38.298 - TsInputTrafficProcessor.OpenTransponder 1
13:18:38.299 - FilterManager::OnSetTransponder SetChannel
13:18:38.301 - TimeShift.Reset
13:18:38.301 - Api2BaseModule.OnTunerStateChanged Preparing
13:18:38.302 - TimeShift.Cursor reset
13:18:38.304 - Api2BaseModule.OnTunerStateChanged  -4
13:18:38.306 - ReaderCursor::Reset.. OK
13:18:38.312 - Prereader.Reset ...13:18:38.313 - Api2BaseModule.OnTunerStateChanged Playing
-OK
13:18:38.318 - ModuleList::ChangeChannel 0
13:18:38.318 - Api2BaseModule.OnTunerStateChanged  -4
13:18:38.320 - [102]ChannelGraph5::StartChannel Черноморская ТРК
13:18:38.324 - 
13:18:38.326 - [102]       #################### Start stream. (0.234ms) #######################
13:18:38.328 - 
13:18:38.349 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
13:18:38.351 - TimeShift.Cursor SetChannel::v 0 (0)
13:18:38.353 - ReaderCursor::SetChannel.. OK
13:18:38.358 - ReaderCursor::SetPosition 0 (w=0)
13:18:38.360 - Prereader.SetChannel..
13:18:38.362 - Prereader.SetChannel unmask 1
13:18:38.364 - Plugin::SetChannel 43981
13:18:38.366 - TransponderManager::SelectChannel
13:18:38.368 - TsInputTrafficProcessor.SelectChannel 43981
13:18:38.370 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:38.372 - TsInputTrafficProcessor.UpdateChannel 43981
13:18:38.374 - GraphState: Undef by StartChannelIsReady
13:18:38.377 - PreScanner.StartChannelIsReady net=1 parseall=1
13:18:38.379 - VideoMediaTypeDetection: mpeg2
13:18:38.380 - SetMarkerAudioLngStream Gen New stream
13:18:38.382 - SimpleTsDemux::Init apid=257, vpid=100
13:18:38.384 - GraphState: RequestPATScan by StartChannelIsReady TS
13:18:38.386 - Api2BaseModule.Filters_EnabledFullTS 1
13:18:38.390 - PlayTimePATParser.OpenParser 43981
13:18:38.392 - Open TSTS filter pid=0 data=0
13:18:38.394 - TSTS cur size=0
13:18:38.397 - Graph::UpdateRenderMode
13:18:38.464 - Graph::SetVideoRect {8 8 712 568}
13:18:38.466 - Graph::SetVideoWindowRect {0 7 919 509}
13:18:38.468 - [102]OnChangeCurrentGraph2 -endOfSetChannel
13:18:38.470 - ChannelGraph5.SetActiveState 1
13:18:38.523 - OSDManager::Window_Add
13:18:38.527 - OSDManager::Window_Show
13:18:38.540 - * s:0 q:0 tr=0 (0) Preparing
13:18:38.560 - OSDManager::Window_Show
13:18:38.564 - OSDManager::Window_Show
13:18:38.632 - OK. 102
13:18:38.671 - Api2BaseModule.EngineApi_ChList_SendSubChannels 0/2
13:18:38.749 - 
13:18:38.751 -        #################### First traffic. (0.656ms) #######################
13:18:38.754 - 
13:18:38.756 - PlayTimePATParser.EndTask
13:18:38.758 - TransportMarker: TS
13:18:38.758 - PreScanner.OnAfterScanPat count=2 {1;4096}
13:18:38.760 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:38.765 - Api2BaseModule.Filters_EnabledFullTS 0
13:18:38.768 - GraphState: RequestPMTScan by OnAfterScanPat
13:18:38.770 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=1
13:18:38.772 - Open TSTS filter pid=4096 data=2
13:18:38.774 - TSTS cur size=271472
13:18:38.777 - TSTS quick finish
13:18:38.779 - --SwitchEngineTransport TS > TS
13:18:38.781 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:38.783 - PreScanner.OnTransportMarker TS
13:18:38.785 - --SwitchEngineTransport end
13:18:38.787 - PreScanner.OnAfterScanPmt pmt=4096
13:18:38.789 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
13:18:38.792 - PlayTimePmtParser::StopParser
13:18:38.813 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
13:18:38.815 - TimeShift.Cursor SetChannel::v 757640 (757640)
13:18:38.817 - Prereader.SetChannel unmask 1
13:18:38.819 - Plugin::SetChannel 1
13:18:38.821 - TransponderManager::SelectChannel
13:18:38.823 - TsInputTrafficProcessor.SelectChannel 1
13:18:38.826 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:38.828 - TsInputTrafficProcessor.UpdateChannel 1
13:18:38.830 - PreScanner.StartChannelIsReady net=1 parseall=0
13:18:38.832 - LngDefaultSelector.try select audio pid=257 type=1 lng=0-(deu,deu,rus) l=99
13:18:38.834 - ChannelGraph5::AfterDetectChannelParams
13:18:38.836 - VideoMediaTypeDetection: h.264
13:18:38.838 - SimpleTsDemux::Init apid=257, vpid=256
13:18:38.841 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
13:18:38.843 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
13:18:38.845 - Prereader::ReaderCursor.. OK
13:18:38.849 - ReaderCursor::SetPosition 0 (w=967636)
13:18:38.851 - Prereader.StartPlayback Push buffering=0 recv=000002846B2E5DF8 [StartChannelHelperBase(sl)]
13:18:38.854 - Prereader.StartPlayback after lock
13:18:38.855 - PreScanner.StartPmtParserIfNeed
13:18:38.858 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=0
13:18:38.858 - VideoParser::First packet 8115 h.264
13:18:38.860 - Open TSTS filter pid=4096 data=2
13:18:38.862 - VideoParser::packet 15480
13:18:38.864 - TSTS cur size=1111832
13:18:38.866 - VideoParser::packet 23869
13:18:38.870 - AudioParser::First packet 2048
13:18:38.872 - AudioParser::AAC detected
13:18:38.874 - VideoParser::packet 32358
13:18:38.877 - VideoParser::packet 90685
13:18:38.879 - h264 detected 15 ms
13:18:38.881 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
13:18:38.884 - PreScanner.Post_InitRender [ReceiveTraffic]
13:18:38.900 - OSDManager::Window_Show
13:18:38.911 - [102]sm: TvInitRenderer 1
13:18:38.913 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
13:18:38.915 - CalculBufferingSize prov=00000284683A14F4 marker=1 request=1
13:18:38.917 - CalculBuffering 2000ms br=2276kb to 569 kbytes. from marker
13:18:38.919 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
13:18:38.921 - Prereader::ReaderCursor.. OK
13:18:38.925 - ReaderCursor::SetPosition 0 (w=1816080)
13:18:38.927 - Prereader.StartPlayback Pull buffering=582750 recv=0000000000000000 [EnablePullModeAndStartPlayback]
13:18:38.930 - Prereader.StartPlayback after lock
13:18:38.932 - Buffering/prereader size 569/3906 kbytes
13:18:38.934 - ------sGetVideoParams
13:18:38.936 - ChannelGraph5.CreateInterfacesAndRenderGraph
13:18:38.937 - * s:100 q:100 tr=1817584 (0) Preparing
13:18:38.940 - OnBuffering.OnTunerStateChanged  4
13:18:38.941 - subsm.StartChannel demux=ProgDemux tr=TS
13:18:38.946 - subsm.RecreateSubtitlesParsers 00000284682D3080 ts=1 subindex=-1
13:18:38.947 - subsm.Set Teletext parser 0
13:18:38.949 - subsm.RecreateSubtitlesParsers end
13:18:38.951 - subs: OnSetChannel
13:18:38.953 - CreateCustomGraph
13:18:38.955 - VideoType:H.264/AVC ffmpeg=0
13:18:38.957 - Video/4.H264 : MPEG2_VIDEO s={0,0,720,576}, t={0,0,720,576}, bmp=720x576, r=16/9, br=0,frametime=40ms, IF=0x0, CF=0x0)
13:18:38.959 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
13:18:38.997 - OK
13:18:38.999 - CChannelGraph5::CreateRender 10
13:18:39.001 - VR: EVR Custom
13:18:39.003 - VR: create new render
13:18:39.055 - VR: Add video renderer Video Renderer - OK
13:18:39.057 - CreateAudioPartOfGraph
13:18:39.060 - AudioType:AAC/ADTS 
13:18:39.062 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
13:18:39.065 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
13:18:39.074 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
13:18:39.076 - Added audio renderer
13:18:39.078 - AP: created
13:18:39.081 - Added audio processor
13:18:39.092 - Connect codec to AP - OK
13:18:39.108 - Add and connect audio renderer - OK
13:18:39.110 - Graph::AfterRender
13:18:39.112 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
13:18:39.114 - AV:UpdateAudioParamsAfterActive
13:18:39.116 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:18:39.118 - GR:UpdateAudioProcessor old=1 new=0
13:18:39.120 - Destroy Audio Processor udate
13:18:39.122 - Graph::SetVolume 5% -5402db
13:18:39.125 - Graph::SetAudioChannelMask
13:18:39.127 - Graph::Run
13:18:39.178 - Graph::Run 1
13:18:39.183 - Graph::SetPictureParams
13:18:39.185 - Graph::SetVideoRect {8 8 712 568}
13:18:39.186 - Graph::SetVideoWindowRect {0 0 919 516}
13:18:39.234 - CChannelGraph5::HideSubtitles
13:18:39.278 - 
13:18:39.280 - [0]########################### Mark of finish channel changing. (1.187ms) #############
13:18:39.282 - 
13:18:39.368 - 
13:18:39.375 - [0]########################### First video frame. (1.281ms) #############
13:18:39.380 - 
13:18:39.488 - * s:100 q:100 tr=2142072 (0) Playing
13:18:40.138 - * s:100 q:100 tr=0 (0) Playing
13:18:40.903 - 
13:18:40.905 - 
13:18:40.907 - ########################### Mark of start channel changing.###########################
13:18:40.909 - 
13:18:40.911 - GraphManager::MainChangeChannel ЧП.INFO  1 provs
13:18:40.913 - DevicesManager::DestroyAllTransponderManagerUsedForSetTransponders
13:18:40.915 - SetChannelLogic::SetChannel 0
13:18:40.917 - SetChannelLogic::SetNormalChannel
13:18:40.923 - ChannelGraph5::StopChannel ЧП.INFO
13:18:40.925 - PreScanner.Stop
13:18:40.927 - GraphState: Undef by PreScanner.Stop
13:18:40.931 - PlayTimePmtParser::StopParser
13:18:40.933 - TimeShift.Cursor PushMode 0 0 (pos=0) [Engine5ChannelBase.StopChannel]
13:18:40.935 - Prereader::ReaderCursor.. OK
13:18:40.939 - ReaderCursor::SetPosition 0 (w=4952108)
13:18:40.941 - Prereader.StartPlayback Disable buffering=0 recv=0000000000000000 [Engine5ChannelBase.StopChannel]
13:18:40.943 - Prereader.StartPlayback after lock
13:18:40.945 - subsm.StopChannel
13:18:40.947 - Graph::Stop
13:18:40.976 - Before Stop ...13:18:40.980 - OnGraphStop ...13:18:40.995 - VR: Disconnect
13:18:41.021 - Graph::ReleaseAllFilters
13:18:41.023 - release: Prog Audio renderer - RR - OK.
13:18:41.030 - release: Video Renderer - RR - OK.
13:18:41.047 - release: Video decoder  - RR - OK.
13:18:41.055 - release: Audio Processor - RR - OK.
13:18:41.060 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
13:18:41.066 - FilterGraph: 1
13:18:41.069 - 
13:18:41.071 - TransponderManager::SetTransponder (CH) 0 ЧП.INFO
13:18:41.073 - *Transport TS
13:18:41.074 - Api2Device::SetChannel http://hls2.lan.ua:8041/index.m3u8
13:18:41.091 - Api2BaseModule.OnTunerStateChanged Connecting
13:18:41.094 - Api2BaseModule.OnTunerStateChanged  -3
13:18:41.098 - Api2Device::SetChannel result OK
13:18:41.100 - TrafficProcessingScheme_OnSetChannelOrTransponder ch=43981
13:18:41.102 - TsInputTrafficProcessor.OpenTransponder 1
13:18:41.104 - FilterManager::OnSetTransponder SetChannel
13:18:41.106 - TimeShift.Reset
13:18:41.107 - Api2BaseModule.OnTunerStateChanged Preparing
13:18:41.108 - TimeShift.Cursor reset
13:18:41.110 - Api2BaseModule.OnTunerStateChanged  -4
13:18:41.112 - ReaderCursor::Reset.. OK
13:18:41.118 - Prereader.Reset ...-OK
13:18:41.121 - Api2BaseModule.OnTunerStateChanged Playing
13:18:41.123 - ModuleList::ChangeChannel 0
13:18:41.124 - Api2BaseModule.OnTunerStateChanged  -4
13:18:41.126 - [102]ChannelGraph5::StartChannel ЧП.INFO
13:18:41.131 - 
13:18:41.133 - [102]       #################### Start stream. (0.235ms) #######################
13:18:41.135 - 
13:18:41.154 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=1
13:18:41.156 - TimeShift.Cursor SetChannel::v 0 (0)
13:18:41.158 - ReaderCursor::SetChannel.. OK
13:18:41.162 - ReaderCursor::SetPosition 0 (w=0)
13:18:41.164 - Prereader.SetChannel..
13:18:41.165 - Prereader.SetChannel unmask 1
13:18:41.167 - Plugin::SetChannel 43981
13:18:41.169 - TransponderManager::SelectChannel
13:18:41.171 - TsInputTrafficProcessor.SelectChannel 43981
13:18:41.173 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:41.175 - TsInputTrafficProcessor.UpdateChannel 43981
13:18:41.178 - GraphState: Undef by StartChannelIsReady
13:18:41.180 - PreScanner.StartChannelIsReady net=1 parseall=1
13:18:41.182 - VideoMediaTypeDetection: mpeg2
13:18:41.184 - SetMarkerAudioLngStream Gen New stream
13:18:41.186 - SimpleTsDemux::Init apid=257, vpid=100
13:18:41.188 - GraphState: RequestPATScan by StartChannelIsReady TS
13:18:41.190 - Api2BaseModule.Filters_EnabledFullTS 1
13:18:41.193 - PlayTimePATParser.OpenParser 43981
13:18:41.195 - Open TSTS filter pid=0 data=0
13:18:41.197 - TSTS cur size=0
13:18:41.199 - Graph::UpdateRenderMode
13:18:41.229 - Graph::SetVideoRect {8 8 712 568}
13:18:41.231 - Graph::SetVideoWindowRect {0 0 919 516}
13:18:41.233 - [102]OnChangeCurrentGraph2 -endOfSetChannel
13:18:41.235 - ChannelGraph5.SetActiveState 1
13:18:41.261 - OSDManager::Window_Show
13:18:41.275 - OSDManager::Window_Show
13:18:41.289 - OSDManager::Window_Show
13:18:41.336 - OK. 102
13:18:41.375 - Api2BaseModule.EngineApi_ChList_SendSubChannels 0/2
13:18:41.449 - * s:0 q:0 tr=0 (0) Preparing
13:18:41.472 - TransportMarker: TS
13:18:41.474 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:41.477 - 
13:18:41.479 -        #################### First traffic. (0.579ms) #######################
13:18:41.481 - 
13:18:41.484 - PlayTimePATParser.EndTask
13:18:41.542 - --SwitchEngineTransport TS > TS
13:18:41.544 - TimeShiftBuffer.SetContentLenght TimeshiftOverNetModule disabled req=0 size=209715200
13:18:41.546 - PreScanner.OnTransportMarker TS
13:18:41.548 - --SwitchEngineTransport end
13:18:41.550 - PreScanner.OnAfterScanPat count=2 {1;4096}
13:18:41.552 - Api2BaseModule.Filters_EnabledFullTS 0
13:18:41.555 - GraphState: RequestPMTScan by OnAfterScanPat
13:18:41.557 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=1
13:18:41.560 - Open TSTS filter pid=4096 data=2
13:18:41.562 - TSTS cur size=821936
13:18:41.564 - TSTS quick finish
13:18:41.584 - OSDManager::Window_Show
13:18:41.594 - PreScanner.OnAfterScanPmt pmt=4096
13:18:41.596 - GraphState: RequestMediaTypeDetection by OnAfterScanPmt
13:18:41.598 - PlayTimePmtParser::StopParser
13:18:41.620 - TimeShift.Cursor SetChannel pidmask=0000000000000000 first=0
13:18:41.622 - TimeShift.Cursor SetChannel::v 1170488 (1170488)
13:18:41.624 - Prereader.SetChannel unmask 1
13:18:41.626 - Plugin::SetChannel 1
13:18:41.629 - TransponderManager::SelectChannel
13:18:41.631 - TsInputTrafficProcessor.SelectChannel 1
13:18:41.633 - Api2BaseModule.UpdateAllOpenedChannels 1
13:18:41.636 - TsInputTrafficProcessor.UpdateChannel 1
13:18:41.638 - PreScanner.StartChannelIsReady net=1 parseall=0
13:18:41.667 - LngDefaultSelector.try select audio pid=257 type=1 lng=0-(deu,deu,rus) l=99
13:18:41.670 - ChannelGraph5::AfterDetectChannelParams
13:18:41.670 - VideoMediaTypeDetection: h.264
13:18:41.674 - SimpleTsDemux::Init apid=257, vpid=256
13:18:41.676 - GraphState: RequestMediaTypeDetection by OnAfterDetectChannelParams
13:18:41.679 - TimeShift.Cursor PushMode 1 1 (pos=0) [StartChannelHelperBase(sl)]
13:18:41.681 - Prereader::ReaderCursor.. OK
13:18:41.685 - ReaderCursor::SetPosition 0 (w=1771524)
13:18:41.687 - Prereader.StartPlayback Push buffering=0 recv=000002846B2E5DF8 [StartChannelHelperBase(sl)]
13:18:41.689 - Prereader.StartPlayback after lock
13:18:41.691 - PreScanner.StartPmtParserIfNeed
13:18:41.693 - PlayTimePmtParser::OpenParser SID=1 PMT=4096 unknow channel=0
13:18:41.694 - VideoParser::First packet 6226 h.264
13:18:41.696 - Open TSTS filter pid=4096 data=2
13:18:41.698 - VideoParser::packet 13227
13:18:41.700 - TSTS cur size=2003516
13:18:41.702 - VideoParser::packet 22379
13:18:41.706 - VideoParser::packet 28321
13:18:41.709 - AudioParser::First packet 2711
13:18:41.711 - AudioParser::AAC detected
13:18:41.714 - VideoParser::packet 35563
13:18:41.714 - VideoParser::packet 42926
13:18:41.720 - VideoParser::packet 49107
13:18:41.722 - VideoParser::packet 56879
13:18:41.724 - VideoParser::packet 64996
13:18:41.726 - VideoParser::packet 72610
13:18:41.728 - VideoParser::packet 80358
13:18:41.730 - VideoParser::packet 88160
13:18:41.732 - VideoParser::packet 169420
13:18:41.734 - h264 detected 32 ms
13:18:41.737 - GraphState: GraphCreating by ReceiveTraffic !RequestAudioMediaType
13:18:41.739 - PreScanner.Post_InitRender [ReceiveTraffic]
13:18:41.742 - [102]sm: TvInitRenderer 1
13:18:41.744 - ChannelGraph5.uiThread_CreateGraphAfterDetectOfMediaTypes
13:18:41.747 - CalculBufferingSize prov=00000284683A14F4 marker=1 request=1
13:18:41.749 - CalculBuffering 2000ms br=3111kb to 777 kbytes. from marker
13:18:41.751 - TimeShift.Cursor PushMode 2 0 (pos=0) [EnablePullModeAndStartPlayback]
13:18:41.754 - Prereader::ReaderCursor.. OK
13:18:41.758 - ReaderCursor::SetPosition 0 (w=2417680)
13:18:41.761 - Prereader.StartPlayback Pull buffering=796500 recv=0000000000000000 [EnablePullModeAndStartPlayback]
13:18:41.763 - Prereader.StartPlayback after lock
13:18:41.765 - Buffering/prereader size 777/3906 kbytes
13:18:41.767 - ------sGetVideoParams
13:18:41.769 - ChannelGraph5.CreateInterfacesAndRenderGraph
13:18:41.770 - * s:100 q:100 tr=2484796 (0) Preparing
13:18:41.773 - OnBuffering.OnTunerStateChanged  4
13:18:41.774 - subsm.StartChannel demux=ProgDemux tr=TS
13:18:41.778 - subsm.RecreateSubtitlesParsers 00000284682D3080 ts=1 subindex=-1
13:18:41.780 - subsm.Set Teletext parser 0
13:18:41.782 - subsm.RecreateSubtitlesParsers end
13:18:41.784 - subs: OnSetChannel
13:18:41.786 - CreateCustomGraph
13:18:41.789 - VideoType:H.264/AVC ffmpeg=0
13:18:41.791 - Video/4.H264 : MPEG2_VIDEO s={0,0,720,576}, t={0,0,720,576}, bmp=720x576, r=16/9, br=0,frametime=40ms, IF=0x0, CF=0x0)
13:18:41.793 - Add video codec ee30215d-164f-4a92-a4eb-9d4c13390f9f
13:18:41.825 - OK
13:18:41.827 - CChannelGraph5::CreateRender 10
13:18:41.830 - VR: EVR Custom
13:18:41.832 - VR: create new render
13:18:41.891 - VR: Add video renderer Video Renderer - OK
13:18:41.894 - CreateAudioPartOfGraph
13:18:41.897 - AudioType:AAC/ADTS 
13:18:41.899 - Audio/00001600-0000-0010-8000-00aa00389b71 : WaveFormatEx (2ch 48000 16bit formatTag= 0x1600)
13:18:41.903 - Add audio codec e1f1a0b8-beee-490d-ba7c-066c40b5e2b9 - OK
13:18:41.913 - IMyGraphBuilder::CreateAudioRenderFilter::ProgAR:Первичный звуковой драйвер OK (normal)
13:18:41.916 - Added audio renderer
13:18:41.918 - AP: created
13:18:41.921 - Added audio processor
13:18:41.934 - Connect codec to AP - OK
13:18:41.951 - Add and connect audio renderer - OK
13:18:41.953 - Graph::AfterRender
13:18:41.956 - GraphState: GraphStarted by CreateInterfacesAndRenderGraph
13:18:41.958 - AV:UpdateAudioParamsAfterActive
13:18:41.960 - AV:UpdateAudioProcessor spec=0 agc=0 bands=0
13:18:41.962 - GR:UpdateAudioProcessor old=1 new=0
13:18:41.964 - Destroy Audio Processor udate
13:18:41.966 - Graph::SetVolume 5% -5402db
13:18:41.969 - Graph::SetAudioChannelMask
13:18:41.971 - Graph::Run
13:18:42.017 - Graph::Run 1
13:18:42.022 - Graph::SetPictureParams
13:18:42.024 - Graph::SetVideoRect {8 8 712 568}
13:18:42.026 - Graph::SetVideoWindowRect {0 0 919 516}
13:18:42.076 - CChannelGraph5::HideSubtitles
13:18:42.090 - 
13:18:42.092 - [0]########################### Mark of finish channel changing. (1.188ms) #############
13:18:42.094 - 
13:18:42.299 - 
13:18:42.301 - [0]########################### First video frame. (1.391ms) #############
13:18:42.303 - 
13:18:42.484 - * s:100 q:100 tr=2327440 (0) Playing
13:18:43.136 - * s:100 q:100 tr=0 (0) Playing
13:18:43.918 - * s:100 q:100 tr=1251516 (0) Playing
13:18:44.483 - * s:100 q:100 tr=0 (0) Playing
13:18:45.134 - * s:100 q:100 tr=0 (0) Playing
13:18:45.923 - * s:100 q:100 tr=0 (0) Playing
13:18:46.484 - * s:100 q:100 tr=0 (0) Playing
13:18:46.918 - OSDManager::Window_Show
13:18:46.936 - OSDManager::Window_Delete
13:18:47.137 - * s:0 q:0 tr=0 (0) Playing
13:18:47.919 - * s:0 q:0 tr=0 (0) Playing
13:18:48.921 - * s:100 q:100 tr=1171052 (0) Playing
13:18:49.923 - * s:100 q:100 tr=0 (0) Playing
13:18:50.923 - * s:100 q:100 tr=1241364 (0) Playing
13:18:51.918 - * s:100 q:100 tr=0 (0) Playing
13:18:52.918 - * s:100 q:100 tr=0 (0) Playing
13:18:53.919 - * s:100 q:100 tr=0 (0) Playing
13:18:54.917 - * s:100 q:100 tr=0 (0) Playing
13:18:55.918 - * s:0 q:0 tr=0 (0) Playing
13:18:56.922 - * s:100 q:100 tr=1267684 (0) Playing
13:18:57.922 - * s:100 q:100 tr=0 (0) Playing
13:18:58.919 - * s:100 q:100 tr=1148680 (0) Playing
13:18:59.919 - * s:100 q:100 tr=0 (0) Playing
13:19:00.918 - * s:100 q:100 tr=0 (0) Playing
13:19:01.240 - 
13:19:01.242 - Stop engine
13:19:01.245 - DevicesManager::Stop
13:19:01.249 - ChannelGraph5::StopChannel 
13:19:01.251 - PreScanner.Stop
13:19:01.253 - GraphState: Undef by PreScanner.Stop
13:19:01.256 - PlayTimePmtParser::StopParser
13:19:01.258 - TimeShift.Cursor PushMode 0 0 (pos=0) [Engine5ChannelBase.StopChannel]
13:19:01.262 - Prereader::ReaderCursor.. OK
13:19:01.266 - ReaderCursor::SetPosition 0 (w=10882192)
13:19:01.268 - Prereader.StartPlayback Disable buffering=0 recv=0000000000000000 [Engine5ChannelBase.StopChannel]
13:19:01.270 - Prereader.StartPlayback after lock
13:19:01.272 - subsm.StopChannel
13:19:01.274 - Graph::Stop
13:19:01.309 - Before Stop ...13:19:01.313 - OnGraphStop ...13:19:01.329 - VR: Disconnect
13:19:01.353 - Graph::ReleaseAllFilters
13:19:01.355 - release: Prog Audio renderer - RR - OK.
13:19:01.362 - release: Video Renderer - RR - OK.
13:19:01.380 - release: Video decoder  - RR - OK.
13:19:01.388 - release: Audio Processor - RR - OK.
13:19:01.393 - release: Microsoft DTV-DVD Audio Decoder - RR - OK.
13:19:01.398 - FilterGraph: 1
13:19:01.399 - remove graph idx=0 count=1
13:19:01.404 - ChannelGraph5.~CChannelGraph5
13:19:01.406 - PreScanner.Stop
13:19:01.408 - GraphState: Undef by PreScanner.Stop
13:19:01.410 - PlayTimePmtParser::StopParser
13:19:01.413 - subsm.StopChannel
13:19:01.415 - Graph::ReleaseAllFilters
13:19:01.427 - ChannelGraph5.~CChannelGraph5 finish
13:19:01.447 - TransponderManager::CloseChannel
13:19:01.449 - TsInputTrafficProcessor.RemoveChannel 1
13:19:01.451 - ~TransponderChannelSource
13:19:01.463 - TimeShift.DestroyReadingCursor
13:19:01.469 - Prereader.Exit13:19:01.471 - Api2BaseModule.UpdateAllOpenedChannels 0
13:19:01.474 - Destroy TSTS filter pid=0
13:19:01.476 - PlayTimePmtParser::StopParser
13:19:01.478 - Destroy TSTS filter pid=4096
13:19:01.481 - DevicesManager::DestroyTransponderManager
13:19:01.483 - Api2Device::SetChannel - None
13:19:01.501 - Api2Device::SetChannel result OK
13:19:01.503 - SetOwner N -> 0
13:19:01.505 - SetOwner SetTransponder null
13:19:01.508 - ~TransponderManager
13:19:01.510 - SetOwner N -> 0
13:19:01.513 - SetOwner SetTransponder null
13:19:01.517 - TimeShift.~TimeShift
13:19:01.520 - HugeMemoryBlocksManager::Free
13:19:01.522 - ModuleList::Free
13:19:01.529 - DevicesManager::Free devices
13:19:01.532 - SDP:Destroy netclient.0 own=0000000000000000
13:19:01.537 - SDP:after destroy device
13:19:01.539 - DevicesManager::Free RC
13:19:01.541 - Engine stopped
13:19:01.552 - 
13:19:01.554 - Stop engine
13:19:01.556 - DevicesManager::Stop
13:19:01.560 - DevicesManager::Free devices
13:19:01.563 - Engine stopped
13:19:01.636 - HugeMemoryBlocksManager::FreeAll
