[mythtv] Re: [mythtv-commits] mythtv commit: r7133 by danielk
Allan Stirling
Dibblahmythml0015 at pendor.org
Thu Aug 25 21:16:56 UTC 2005
Daniel Kristjansson wrote:
> On Thu, 2005-08-25 at 20:52 +0100, Allan Stirling wrote:
>
>>Debugging with this version makes it pretty obvious that something's
>>awry, but I don't yet see what. Still looking...:
>
>
>>2005-08-25 20:42:09.266 SM: AddFlags: Seen(PAT,) Match() Wait()
>>2005-08-25 20:42:09.266 SM: AddFlags: Seen() Match(PAT,) Wait()
>
> Looks good so far.
>
>
>>2005-08-25 20:42:09.270 DVBSM(0)::AddPIDFilter(0x104):
>
> Ok, we have a pid, good.
>
>
>>2005-08-25 20:42:09.279 PSIP packet failed CRC check
>>2005-08-25 20:42:09.405 PSIP packet failed CRC check
>>2005-08-25 20:42:09.539 PSIP packet failed CRC check
>
> <snip>
> It looks like the PMT is failing the CRC check.
>
>
>>2005-08-25 20:42:11.939 TVRec: Timed out waiting for lock -- aborting
>>recording
>
> Not so surprising...
>
> I've attached a patch which will verify that the PMT is the
> table failing the CRC check. If it is then this will print out:
> PSIP packet failed CRC check. pid(0x104) type(0x2)
>
> -- Daniel
>
>
>
> ------------------------------------------------------------------------
>
> Index: libs/libmythtv/mpeg/mpegstreamdata.cpp
> ===================================================================
> --- libs/libmythtv/mpeg/mpegstreamdata.cpp (revision 7132)
> +++ libs/libmythtv/mpeg/mpegstreamdata.cpp (working copy)
> @@ -354,7 +354,9 @@
> // Validate PSIP
> if (!psip->IsGood())
> {
> - VERBOSE(VB_RECORD, QString("PSIP packet failed CRC check"));
> + VERBOSE(VB_RECORD, QString("PSIP packet failed CRC check. "
> + "pid(0x%1) type(0x%2)")
> + .arg(tspacket->PID(),0,16).arg(psip->TableID(),0,16));
> HT_RETURN(true);
> }
>
>
>
> ------------------------------------------------------------------------
>
> _______________________________________________
> mythtv-dev mailing list
> mythtv-dev at mythtv.org
> http://mythtv.org/cgi-bin/mailman/listinfo/mythtv-dev
2005-08-25 22:09:04.469 Using runtime prefix = /usr/local
2005-08-25 22:09:04.575 New DB connection, total: 1
Starting up as the master server.
2005-08-25 22:09:04.620 New DB connection, total: 2
2005-08-25 22:09:04.623 mythbackend: MythBackend started as master server
2005-08-25 22:09:04.656 Start channel '
2005-08-25 22:09:04.657 DVB#0 Opening DVB channel
2005-08-25 22:09:04.664 DVB#0 Using DVB card 0, with frontend ST STV0299
DVB-S.
2005-08-25 22:09:04.972 DVB#0 Trying to tune to channel 51001.
2005-08-25 22:09:04.974 New DB connection, total: 3
2005-08-25 22:09:04.978 DVB#0 Frequency: 11661540 Symbol Rate: 27500000
Pol: H/L Inv: Auto
2005-08-25 22:09:05.284 DVB#0 DiSEqC 1.0 Switch - Port 0
2005-08-25 22:09:05.301 DVB#0 DiSEqC Sending 1.0 Command: e0 10 38 f2
2005-08-25 22:09:05.389 DVB#0 Event Status() frequency(1911540 Hz)
2005-08-25 22:09:05.389 DVB#0 Waiting for frontend event after tune.
2005-08-25 22:09:05.389 DVB#0 Frequency tuning successful.
2005-08-25 22:09:05.390 DVB#0 Tuned to frequency for channel 51001.
2005-08-25 22:09:05.390 SetSignalMonitoringRate(50, 0)
2005-08-25 22:09:05.390 SetupSignalMonitor()
2005-08-25 22:09:05.390 DVB#0 Opening DVB channel
2005-08-25 22:09:05.390 SetupSignalMonitor() -- DVB hack begin
2005-08-25 22:09:05.390 SetupSignalMonitor() -- DVB hack end
2005-08-25 22:09:05.598 SM: AddFlags: Seen() Match()
Wait(Sig,SNR,BER,UB,)
2005-08-25 22:09:05.598 DVBSM(0)::constructor(): initial flags 0x7400000
2005-08-25 22:09:05.598 signal monitor successfully created
2005-08-25 22:09:05.598 Setting up table monitoring.
2005-08-25 22:09:05.598 Not ATSC channel: major(-1) minor(-1).
2005-08-25 22:09:05.598 mpeg program number: 51001
2005-08-25 22:09:05.599 DTVSM(0)::SetProgramNumber(51001):
2005-08-25 22:09:05.599 SM: RemoveFlags: Seen(PMT,) Match(PMT,) Wait()
2005-08-25 22:09:05.599 SM: AddFlags: Seen() Match() Wait(PMT,)
2005-08-25 22:09:05.600 SM: AddFlags: Seen() Match() Wait(PAT,PMT,)
2005-08-25 22:09:05.600 Successfully set up MPEG table monitoring.
2005-08-25 22:09:05.600 SM(0)::Start: begin
2005-08-25 22:09:05.602 SM(0)::Start: end
2005-08-25 22:09:05.602 DTVSM(0)::GetStatusList: WaitForPMT seen(0)
matching(0)
2005-08-25 22:09:05.804 DVBSM(0)::UpdateValues(): Signal Lock
2005-08-25 22:09:05.813 DVBSM(0)::RunTableMonitor(): begin (# of pids 2)
2005-08-25 22:09:05.813 DVBSM(0)::AddPIDFilter(0x0):
2005-08-25 22:09:05.816 DVBSM(0)::AddPIDFilter(0x1ffb):
2005-08-25 22:09:05.932 SM: AddFlags: Seen(PAT,) Match() Wait()
2005-08-25 22:09:05.933 SM: AddFlags: Seen() Match(PAT,) Wait()
2005-08-25 22:09:05.933 CreatePATSingleProgram()
2005-08-25 22:09:05.933 PAT in input stream
2005-08-25 22:09:05.934 Program Association Table
PSIP prefix(0x0) tableID(0x0) length(53) extension(0x96b)
version(18) current(1) section(0) last_section(0)
tsid: 2411
programCount: 11
program number 0 has PID 0x 10 data 0x0 0x0 0x224 0x16
program number 51001 has PID 0x 104 data 0x199 0x57 0x225 0x4
program number 51006 has PID 0x 103 data 0x199 0x62 0x225 0x3
program number 51008 has PID 0x 107 data 0x199 0x64 0x225 0x7
program number 51009 has PID 0x 108 data 0x199 0x65 0x225 0x8
program number 51010 has PID 0x 100 data 0x199 0x66 0x225 0x0
program number 51011 has PID 0x 10c data 0x199 0x67 0x225 0x12
program number 51014 has PID 0x 106 data 0x199 0x70 0x225 0x6
program number 51019 has PID 0x 101 data 0x199 0x75 0x225 0x1
program number 51020 has PID 0x 109 data 0x199 0x76 0x225 0x9
program number 51022 has PID 0x 10b data 0x199 0x78 0x225 0x11
2005-08-25 22:09:05.934 desired_program(51001) pid(0x104)
2005-08-25 22:09:05.934 pmt_pid(0x104)
2005-08-25 22:09:05.934 PAT for output stream
2005-08-25 22:09:05.934 Program Association Table
PSIP prefix(0x0) tableID(0x0) length(13) extension(0x96b)
version(18) current(1) section(0) last_section(0)
tsid: 2411
programCount: 1
program number 1 has PID 0x 104 data 0x0 0x1 0x225 0x4
2005-08-25 22:09:05.935 DVBSM(0)::AddPIDFilter(0x104):
2005-08-25 22:09:05.942 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.064 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.202 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.322 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.446 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.582 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.702 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.824 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:06.948 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.082 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.204 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.342 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.462 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.582 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.704 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.842 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:07.962 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:08.082 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:08.222 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:08.342 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:08.462 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:08.588 PSIP packet failed CRC check. pid(0x104) type(0x2)
2005-08-25 22:09:08.617 TVRec: Timed out waiting for lock -- aborting
recording
2005-08-25 22:09:08.617 SigMon Flags are: Seen(PAT,) Match(PAT,)
Wait(PAT,PMT,Sig,SNR,BER,UB,)
2005-08-25 22:09:08.617 SetSignalMonitoringRate(0, 0)
2005-08-25 22:09:08.617 TeardownSignalMonitor() -- begin
2005-08-25 22:09:08.617 DVBSM(0)::Stop: begin
2005-08-25 22:09:08.617 SM(0)::Stop: begin
2005-08-25 22:09:08.666 SM(0)::Stop: end
2005-08-25 22:09:08.668 DVBSM(0)::RunTableMonitor(): shutdown
2005-08-25 22:09:08.668 DVBSM(0)::RemovePIDFilter(0x0):
2005-08-25 22:09:08.670 DVBSM(0)::RemovePIDFilter(0x104):
2005-08-25 22:09:08.672 DVBSM(0)::RemovePIDFilter(0x1ffb):
2005-08-25 22:09:08.674 DVBSM(0)::RunTableMonitor(): end
2005-08-25 22:09:08.674 DVBSM(0)::Stop: end
2005-08-25 22:09:08.675 DVBSM(0)::Stop: begin
2005-08-25 22:09:08.675 SM(0)::Stop: begin
2005-08-25 22:09:08.675 SM(0)::Stop: end
2005-08-25 22:09:08.675 DVBSM(0)::Stop: end
2005-08-25 22:09:08.675 SM(0)::Stop: begin
2005-08-25 22:09:08.675 SM(0)::Stop: end
2005-08-25 22:09:08.675 TeardownSignalMonitor() -- end
2005-08-25 22:09:08.693 DVB#1 Opening DVB channel
2005-08-25 22:09:08.699 DVB#1 Using DVB card 1, with frontend VLSI
VES1x93 DVB-S.
2005-08-25 22:09:09.006 DVB#1 CA: CI handler successfully initialized!
2005-08-25 22:09:09.007 DVB#1 CA: CI handler thread running
2005-08-25 22:09:09.008 DVB#1 Trying to tune to channel 7301.
2005-08-25 22:09:09.011 DVB#1 Frequency: 12129000 Symbol Rate: 27500000
Pol: V/R Inv: Auto
2005-08-25 22:09:09.011 DVB#1 Setting LNB: Tone ON 13V
2005-08-25 22:09:09.028 DVB#1 Event Status() frequency(1529000 Hz)
2005-08-25 22:09:09.028 DVB#1 Waiting for frontend event after tune.
2005-08-25 22:09:09.028 DVB#1 Frequency tuning successful.
2005-08-25 22:09:09.028 DVB#1 Tuned to frequency for channel 7301.
2005-08-25 22:09:09.028 SetSignalMonitoringRate(50, 0)
2005-08-25 22:09:09.028 SetupSignalMonitor()
2005-08-25 22:09:09.028 DVB#1 Opening DVB channel
2005-08-25 22:09:09.028 SetupSignalMonitor() -- DVB hack begin
2005-08-25 22:09:09.028 SetupSignalMonitor() -- DVB hack end
2005-08-25 22:09:09.032 SM: AddFlags: Seen() Match()
Wait(Sig,SNR,BER,UB,)
2005-08-25 22:09:09.032 DVBSM(1)::constructor(): initial flags 0x7400000
2005-08-25 22:09:09.032 signal monitor successfully created
2005-08-25 22:09:09.032 Setting up table monitoring.
2005-08-25 22:09:09.032 Not ATSC channel: major(-1) minor(-1).
2005-08-25 22:09:09.033 mpeg program number: 7301
2005-08-25 22:09:09.033 DTVSM(1)::SetProgramNumber(7301):
2005-08-25 22:09:09.033 SM: RemoveFlags: Seen(PMT,) Match(PMT,) Wait()
2005-08-25 22:09:09.033 SM: AddFlags: Seen() Match() Wait(PMT,)
2005-08-25 22:09:09.034 SM: AddFlags: Seen() Match() Wait(PAT,PMT,)
2005-08-25 22:09:09.034 Successfully set up MPEG table monitoring.
2005-08-25 22:09:09.034 SM(1)::Start: begin
2005-08-25 22:09:09.038 SM(1)::Start: end
2005-08-25 22:09:09.103 DVBSM(1)::UpdateValues(): Signal Lock
2005-08-25 22:09:09.111 DVBSM(1)::RunTableMonitor(): begin (# of pids 2)
2005-08-25 22:09:09.111 DVBSM(1)::AddPIDFilter(0x0):
2005-08-25 22:09:09.114 DVBSM(1)::AddPIDFilter(0x1ffb):
2005-08-25 22:09:09.171 SM: AddFlags: Seen(PAT,) Match() Wait()
2005-08-25 22:09:09.171 SM: AddFlags: Seen() Match(PAT,) Wait()
2005-08-25 22:09:09.172 CreatePATSingleProgram()
2005-08-25 22:09:09.172 PAT in input stream
2005-08-25 22:09:09.172 Program Association Table
PSIP prefix(0x0) tableID(0x0) length(37) extension(0x7e6)
version(17) current(1) section(0) last_section(0)
tsid: 2022
programCount: 7
program number 0 has PID 0x 10 data 0x0 0x0 0x224 0x16
program number 7301 has PID 0x 102 data 0x28 0x133 0x225 0x2
program number 7330 has PID 0x 103 data 0x28 0x162 0x225 0x3
program number 7331 has PID 0x 101 data 0x28 0x163 0x225 0x1
program number 7340 has PID 0x 106 data 0x28 0x172 0x225 0x6
program number 7341 has PID 0x 107 data 0x28 0x173 0x225 0x7
program number 7360 has PID 0x 104 data 0x28 0x192 0x225 0x4
2005-08-25 22:09:09.172 desired_program(7301) pid(0x102)
2005-08-25 22:09:09.172 pmt_pid(0x102)
2005-08-25 22:09:09.172 PAT for output stream
2005-08-25 22:09:09.172 Program Association Table
PSIP prefix(0x0) tableID(0x0) length(13) extension(0x7e6)
version(17) current(1) section(0) last_section(0)
tsid: 2022
programCount: 1
program number 1 has PID 0x 102 data 0x0 0x1 0x225 0x2
2005-08-25 22:09:09.173 DVBSM(1)::AddPIDFilter(0x102):
2005-08-25 22:09:09.186 SM: AddFlags: Seen(PMT,) Match() Wait()
2005-08-25 22:09:09.186 SM: AddFlags: Seen() Match(PMT,) Wait()
2005-08-25 22:09:09.186 CreatePMTSingleProgram()
2005-08-25 22:09:09.187 PMT in input stream
2005-08-25 22:09:09.187 Program Map Table ver(18) pid(0x102) pnum(7301)
Unknown Descriptor (0xb) length(2)
Unknown Descriptor (0xe) length(3)
Unknown Descriptor (0x10) length(6)
Stream #0 pid(0x900) type(video-mp2 0x2)
Unknown Descriptor (0xe) length(3)
Unknown Descriptor (0x2) length(3)
Unknown Descriptor (0x6) length(1)
Stream Identifier Descriptor (0x52) length(1)
Stream #1 pid(0x902) type(audio-mp2-layer[1,2,3] 0x4)
Unknown Descriptor (0xe) length(3)
Unknown Descriptor (0x3) length(1)
ISO-639 Language Descriptor (0xa) length(4)
Stream Identifier Descriptor (0x52) length(1)
Stream #2 pid(0x903) type(audio-mp2-layer[1,2,3] 0x4)
Unknown Descriptor (0xe) length(3)
Unknown Descriptor (0x3) length(1)
ISO-639 Language Descriptor (0xa) length(4)
Stream Identifier Descriptor (0x52) length(1)
Stream #3 pid(0x904) type(audio-mp2-layer[1,2,3] 0x4)
Unknown Descriptor (0xe) length(3)
Unknown Descriptor (0x3) length(1)
ISO-639 Language Descriptor (0xa) length(4)
Stream Identifier Descriptor (0x52) length(1)
Stream #4 pid(0x901) type(unknown 0x6)
Unknown Descriptor (0xe) length(3)
Teletext Descriptor (0x56) length(15)
Stream Identifier Descriptor (0x52) length(1)
2005-08-25 22:09:09.189 PMT for output stream
2005-08-25 22:09:09.189 Program Map Table ver(18) pid(0x102) pnum(1)
Stream #0 pid(0x900) type(video-mp2 0x2)
Stream #1 pid(0x902) type(audio-mp2-layer[1,2,3] 0x4)
Stream #2 pid(0x903) type(audio-mp2-layer[1,2,3] 0x4)
Stream #3 pid(0x904) type(audio-mp2-layer[1,2,3] 0x4)
2005-08-25 22:09:09.193 DTVSM(1)::GetStatusList: WaitForPMT seen(1)
matching(1)
2005-08-25 22:09:12.052 TVRec: Timed out waiting for lock -- aborting
recording
2005-08-25 22:09:12.052 SigMon Flags are: Seen(PAT,PMT,) Match(PAT,PMT,)
Wait(PAT,PMT,Sig,SNR,BER,UB,)
2005-08-25 22:09:12.052 SetSignalMonitoringRate(0, 0)
2005-08-25 22:09:12.053 TeardownSignalMonitor() -- begin
2005-08-25 22:09:12.053 DVBSM(1)::Stop: begin
2005-08-25 22:09:12.053 SM(1)::Stop: begin
2005-08-25 22:09:12.068 SM(1)::Stop: end
2005-08-25 22:09:12.070 DVBSM(1)::RunTableMonitor(): shutdown
2005-08-25 22:09:12.070 DVBSM(1)::RemovePIDFilter(0x0):
2005-08-25 22:09:12.072 DVBSM(1)::RemovePIDFilter(0x102):
2005-08-25 22:09:12.074 DVBSM(1)::RemovePIDFilter(0x1ffb):
2005-08-25 22:09:12.076 DVBSM(1)::RunTableMonitor(): end
2005-08-25 22:09:12.077 DVBSM(1)::Stop: end
2005-08-25 22:09:12.077 DVBSM(1)::Stop: begin
2005-08-25 22:09:12.077 SM(1)::Stop: begin
2005-08-25 22:09:12.077 SM(1)::Stop: end
2005-08-25 22:09:12.077 DVBSM(1)::Stop: end
2005-08-25 22:09:12.077 SM(1)::Stop: begin
2005-08-25 22:09:12.077 SM(1)::Stop: end
2005-08-25 22:09:12.077 TeardownSignalMonitor() -- end
2005-08-25 22:09:12.093 New DB scheduler connection
2005-08-25 22:09:12.102 mythbackend version: 0.19.20050712-1 www.mythtv.org
2005-08-25 22:09:12.103 Enabled verbose msgs : important general channel
record
2005-08-25 22:09:12.108 AutoExpire: Found 2 recorders w/max rate of 277
MiB/min
2005-08-25 22:09:12.110 AutoExpire: space: 2.2 GB w/freq: 5 min
2005-08-25 22:09:14.101 Reschedule requested for id -1.
2005-08-25 22:09:14.114 Scheduled 0 items in 0.0 = 0.01 match + 0.01 place
2005-08-25 22:09:14.119 scheduler: Scheduled items
2005-08-25 22:09:14.125 Seem to be woken up by USER
2005-08-25 22:09:22.107 mythbackend: Running housekeeping thread
Cheers,
Allan.
More information about the mythtv-dev
mailing list