Login | Register For Free | Help
Search for: (Advanced)

Mailing List Archive: MythTV: Users

Problems commflagging on HDPVR

 

 

MythTV users RSS feed   Index | Next | Previous | View Threaded


justin.johnson3 at gmail

Jul 30, 2010, 6:45 AM

Post #1 of 3 (237 views)
Permalink
Problems commflagging on HDPVR

I've recently upgraded to an HDPVR and find it to be the absolute
bee's knees but I'm having some issues with commflagging. First of
all, it takes much longer to commflag, in order to commflag in "real
time" on 1080i I had to lower the bitrate for high resolution
recordings. That's not my problem so much, as it's perfectly
understandable. My system is a core2duo 2.66GHz so I'm just barely not
able to watch HDPVR recordings using software decoding, so I expect
the commflagger to have problems keeping up as well, like I said
that's not the issue. The problem is that sometimes, rarely, the
commflagger doesn't start, I see a number of these messages in
mythbackend.log:

2010-07-29 22:30:19.025
RingBuf(/var/lib/mythtv/recordings/1855_20100729223000.mpg): Invalid
file (fd -1) when opening
/var/lib/mythtv/recordings/1855_20100729223000.mpg'.

It seems to indicate that the file hasn't been synced to disk yet, or
something. The recording is fine and I'm able to watch, but it shows
up as not flagged. Now, this particular recording happened to start
just as mythfilldatabase was also running, so that may have had
something to do with it, but my recordings are on a different drive
than the db. I thought maybe it was due to limiting the number of
simultaneous jobs to 2, so I increased to 4 but got this problem
recording just a couple hours later. It only seems to be a problem
when there are a number of shows in a row that are recording. If I
requeue the commflag job, it runs just fine. I've only noticed it in
situations similar to this:

9:00pm: 2 recordings, one on QAM and one on HDPVR (1080i)
10:00pm: 1 recording on HDPVR (1080i)

The 10pm recording failed to start commflagging. A more complete log is this:

2010-07-27 22:00:12.826 JobQueue: Commercial Flagging Starting for
Covert Affairs "South Bound Suarez" recorded from channel 1842 at Tue
Jul 27 22:00:00 2010
2010-07-27 22:00:12.942 Using runtime prefix = /usr
2010-07-27 22:00:12.943 Using configuration directory = /home/mythtv/.mythtv
2010-07-27 22:00:12.944 Empty LocalHostName.
2010-07-27 22:00:12.943 ProgramInfo(): Updated pathname '':'' ->
'1842_20100727220000.mpg'
2010-07-27 22:00:12.948 Using localhost value of mythbox
2010-07-27 22:00:12.958 New DB connection, total: 1
2010-07-27 22:00:13.001 Connected to database 'mythconverg' at host: 127.0.0.1
2010-07-27 22:00:13.008 Closing DB connection named 'DBManager0'
2010-07-27 22:00:13.052 Connected to database 'mythconverg' at host: 127.0.0.1
2010-07-27 22:00:13.103 ProgramInfo(): Updated pathname '':'' ->
'1842_20100727220000.mpg'
2010-07-27 22:00:14.676 Scheduled 1830 items in 3.3 = 0.01 match + 3.31 place
2010-07-27 22:00:19.607
RingBuf(/var/lib/mythtv/recordings/1842_20100727220000.mpg): Invalid
file (fd -1) when opening
'/var/lib/mythtv/recordings/1842_20100727220000.mpg'.
2010-07-27 22:00:19.689 MythContext: Connecting to backend server:
192.168.1.51:6543 (try 1 of 1)
2010-07-27 22:00:19.690 Using protocol version 23056
2010-07-27 22:00:19.692 MainServer::ANN Playback
2010-07-27 22:00:19.695 adding: mythbox as a client (events: 0)
2010-07-27 22:00:19.701 MainServer::ANN Monitor
2010-07-27 22:00:19.706 adding: mythbox as a client (events: 1)
2010-07-27 22:00:19.742 ProgramInfo(): Updated pathname '':'' ->
'1842_20100727220000.mpg'
2010-07-27 22:00:31.760
RingBuf(/var/lib/mythtv/recordings/1842_20100727220000.mpg) Error:
Invalid file descriptor in 'safe_read()'
2010-07-27 22:00:31.761
RingBuf(/var/lib/mythtv/recordings/1842_20100727220000.mpg) Warning:
Peek() requested 2048 bytes, but only returning 0
2010-07-27 22:00:31.768 NVP::OpenFile(): Error, couldn't read file:
/var/lib/mythtv/recordings/1842_20100727220000.mpg
2010-07-27 22:00:31.826 ProgramInfo(): Updated pathname '':'' ->
'1842_20100727220000.mpg'
2010-07-27 22:00:32.779 ~MythContext waiting for threads to exit.
2010-07-27 22:00:32.832 ProgramInfo(): Updated pathname '':'' ->
'1842_20100727220000.mpg'
2010-07-27 22:00:32.892 ProgramInfo(): Updated pathname '':'' ->
'1842_20100727220000.mpg'

One second after this, a preview is generated fine, so the file
clearly exists. Anyone else see this at times? What can be done?

--Justin Johnson
_______________________________________________
mythtv-users mailing list
mythtv-users [at] mythtv
http://mythtv.org/cgi-bin/mailman/listinfo/mythtv-users


kevincplew at gmail

Jul 30, 2010, 7:22 AM

Post #2 of 3 (230 views)
Permalink
Re: Problems commflagging on HDPVR [In reply to]

I have the exact same issue.
Thanks

On Fri, Jul 30, 2010 at 9:45 AM, Justin Johnson
<justin.johnson3 [at] gmail> wrote:
> I've recently upgraded to an HDPVR and find it to be the absolute
> bee's knees but I'm having some issues with commflagging. First of
> all, it takes much longer to commflag, in order to commflag in "real
> time" on 1080i I had to lower the bitrate for high resolution
> recordings. That's not my problem so much, as it's perfectly
> understandable. My system is a core2duo 2.66GHz so I'm just barely not
> able to watch HDPVR recordings using software decoding, so I expect
> the commflagger to have problems keeping up as well, like I said
> that's not the issue. The problem is that sometimes, rarely, the
> commflagger doesn't start, I see a number of these messages in
> mythbackend.log:
>
> 2010-07-29 22:30:19.025
> RingBuf(/var/lib/mythtv/recordings/1855_20100729223000.mpg): Invalid
> file (fd -1) when opening
> /var/lib/mythtv/recordings/1855_20100729223000.mpg'.
>
> It seems to indicate that the file hasn't been synced to disk yet, or
> something. The recording is fine and I'm able to watch, but it shows
> up as not flagged. Now, this particular recording happened to start
> just as mythfilldatabase was also running, so that may have had
> something to do with it, but my recordings are on a different drive
> than the db. I thought maybe it was due to limiting the number of
> simultaneous jobs to 2, so I increased to 4 but got this problem
> recording just a couple hours later. It only seems to be a problem
> when there are a number of shows in a row that are recording. If I
> requeue the commflag job, it runs just fine. I've only noticed it in
> situations similar to this:
>
> 9:00pm: 2 recordings, one on QAM and one on HDPVR (1080i)
> 10:00pm: 1 recording on HDPVR (1080i)
>
> The 10pm recording failed to start commflagging. A more complete log is this:
>
> 2010-07-27 22:00:12.826 JobQueue: Commercial Flagging Starting for
> Covert Affairs "South Bound Suarez" recorded from channel 1842 at Tue
> Jul 27 22:00:00 2010
> 2010-07-27 22:00:12.942 Using runtime prefix = /usr
> 2010-07-27 22:00:12.943 Using configuration directory = /home/mythtv/.mythtv
> 2010-07-27 22:00:12.944 Empty LocalHostName.
> 2010-07-27 22:00:12.943 ProgramInfo(): Updated pathname '':'' ->
> '1842_20100727220000.mpg'
> 2010-07-27 22:00:12.948 Using localhost value of mythbox
> 2010-07-27 22:00:12.958 New DB connection, total: 1
> 2010-07-27 22:00:13.001 Connected to database 'mythconverg' at host: 127.0.0.1
> 2010-07-27 22:00:13.008 Closing DB connection named 'DBManager0'
> 2010-07-27 22:00:13.052 Connected to database 'mythconverg' at host: 127.0.0.1
> 2010-07-27 22:00:13.103 ProgramInfo(): Updated pathname '':'' ->
> '1842_20100727220000.mpg'
> 2010-07-27 22:00:14.676 Scheduled 1830 items in 3.3 = 0.01 match + 3.31 place
> 2010-07-27 22:00:19.607
> RingBuf(/var/lib/mythtv/recordings/1842_20100727220000.mpg): Invalid
> file (fd -1) when opening
> '/var/lib/mythtv/recordings/1842_20100727220000.mpg'.
> 2010-07-27 22:00:19.689 MythContext: Connecting to backend server:
> 192.168.1.51:6543 (try 1 of 1)
> 2010-07-27 22:00:19.690 Using protocol version 23056
> 2010-07-27 22:00:19.692 MainServer::ANN Playback
> 2010-07-27 22:00:19.695 adding: mythbox as a client (events: 0)
> 2010-07-27 22:00:19.701 MainServer::ANN Monitor
> 2010-07-27 22:00:19.706 adding: mythbox as a client (events: 1)
> 2010-07-27 22:00:19.742 ProgramInfo(): Updated pathname '':'' ->
> '1842_20100727220000.mpg'
> 2010-07-27 22:00:31.760
> RingBuf(/var/lib/mythtv/recordings/1842_20100727220000.mpg) Error:
> Invalid file descriptor in 'safe_read()'
> 2010-07-27 22:00:31.761
> RingBuf(/var/lib/mythtv/recordings/1842_20100727220000.mpg) Warning:
> Peek() requested 2048 bytes, but only returning 0
> 2010-07-27 22:00:31.768 NVP::OpenFile(): Error, couldn't read file:
> /var/lib/mythtv/recordings/1842_20100727220000.mpg
> 2010-07-27 22:00:31.826 ProgramInfo(): Updated pathname '':'' ->
> '1842_20100727220000.mpg'
> 2010-07-27 22:00:32.779 ~MythContext waiting for threads to exit.
> 2010-07-27 22:00:32.832 ProgramInfo(): Updated pathname '':'' ->
> '1842_20100727220000.mpg'
> 2010-07-27 22:00:32.892 ProgramInfo(): Updated pathname '':'' ->
> '1842_20100727220000.mpg'
>
> One second after this, a preview is generated fine, so the file
> clearly exists. Anyone else see this at times? What can be done?
>
> --Justin Johnson
> _______________________________________________
> mythtv-users mailing list
> mythtv-users [at] mythtv
> http://mythtv.org/cgi-bin/mailman/listinfo/mythtv-users
>



--
Kevin Plew
kevincplew [at] gmail
_______________________________________________
mythtv-users mailing list
mythtv-users [at] mythtv
http://mythtv.org/cgi-bin/mailman/listinfo/mythtv-users


justin.johnson3 at gmail

Jul 30, 2010, 4:26 PM

Post #3 of 3 (216 views)
Permalink
Re: Problems commflagging on HDPVR [In reply to]

On Fri, Jul 30, 2010 at 10:22 AM, Kevin Plew <kevincplew [at] gmail> wrote:
> I have the exact same issue.
> Thanks
>
> On Fri, Jul 30, 2010 at 9:45 AM, Justin Johnson
> <justin.johnson3 [at] gmail> wrote:
>> I've recently upgraded to an HDPVR and find it to be the absolute
>> bee's knees but I'm having some issues with commflagging. First of
>> all, it takes much longer to commflag, in order to commflag in "real
>> time" on 1080i I had to lower the bitrate for high resolution
>> recordings. That's not my problem so much, as it's perfectly
>> understandable. My system is a core2duo 2.66GHz so I'm just barely not
>> able to watch HDPVR recordings using software decoding, so I expect
>> the commflagger to have problems keeping up as well, like I said
>> that's not the issue. The problem is that sometimes, rarely, the
>> commflagger doesn't start, I see a number of these messages in
>> mythbackend.log:
>>
>> 2010-07-29 22:30:19.025
>> RingBuf(/var/lib/mythtv/recordings/1855_20100729223000.mpg): Invalid
>> file (fd -1) when opening
>> /var/lib/mythtv/recordings/1855_20100729223000.mpg'.
>>
>> It seems to indicate that the file hasn't been synced to disk yet, or
>> something. The recording is fine and I'm able to watch, but it shows
>> up as not flagged. Now, this particular recording happened to start
>> just as mythfilldatabase was also running, so that may have had
>> something to do with it, but my recordings are on a different drive
>> than the db. I thought maybe it was due to limiting the number of
>> simultaneous jobs to 2, so I increased to 4 but got this problem
>> recording just a couple hours later. It only seems to be a problem
>> when there are a number of shows in a row that are recording. If I
>> requeue the commflag job, it runs just fine. I've only noticed it in
>> situations similar to this:
>>
>> 9:00pm: 2 recordings, one on QAM and one on HDPVR (1080i)
>> 10:00pm: 1 recording on HDPVR (1080i)
>>
>> The 10pm recording failed to start commflagging. A more complete log is this:
>>
[delete]

I've increased the size of my RingBuffer to 64MB, I'll report back
here if I see the same issue pop up again.
--Justin Johnson
_______________________________________________
mythtv-users mailing list
mythtv-users [at] mythtv
http://mythtv.org/cgi-bin/mailman/listinfo/mythtv-users

MythTV users RSS feed   Index | Next | Previous | View Threaded
 
 


Interested in having your list archived? Contact Gossamer Threads
 
  Web Applications & Managed Hosting Powered by Gossamer Threads Inc.