epg123 not importing guide data

An evolving, supported alternative to Rovi
Forum rules
★ Download the latest EPG123 here: http://epg123.garyan2.net <> Setup guide here: http://epg123.garyan2.net/downloads/epg123_Guide.pdf
bomberjim

Posts: 13
Joined: Sat Jul 18, 2015 9:15 pm
Location:

HTPC Specs: Show details

epg123 not importing guide data

#1

Post by bomberjim » Sun Feb 03, 2019 5:20 pm

Running version 1.2.10 on a windows 7 computer, and trying to update 2 times per day at 8am and 4 pm local (if it makes a difference).

For the last 3 days I get the following errors each time. I'm also seeing the red x icon on the windows media center home page.
1.) Unhandeled exception caught from epg123.exe message: Object reference not set to an instance of an object.

2.) Later followed by: MXF filed imported is xx.xx hours old. Where xx.xx is an increasing number of hours, currently about 71.80.

I'm reluctant to do any messing around with the program without checking with you first. Any advice would be greatly appreciated.

Thanks,
Jim L.

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#2

Post by garyan2 » Sun Feb 03, 2019 5:29 pm

If you opted to generate the MMUI+ file, delete file C:\ProgramData\GaRyan2\epg123\output\mmuiplus.json and try again. Hopefully, this is the reason.

If you don't generate that file, or deleting it did not work, then you will need to clear your cache ... the [Clear Cache] button on the configuration GUI. Be forewarned, the response time for program requests are ridiculously long right now from Schedules Direct and it may take a very long time to rebuild the cache... you will have to be patient.
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

bomberjim

Posts: 13
Joined: Sat Jul 18, 2015 9:15 pm
Location:

HTPC Specs: Show details

#3

Post by bomberjim » Sun Feb 03, 2019 6:26 pm

Not sure how to opt to generate an MMUI+ file or what its purpose is. In any event, I don't have a C:\ProgramData\GaRyan2 folder. I DO have a D:\epg123\0utput folder, but it does not contain an mmuiplus.json file only the epg123.mxf file, which is dated back on 31 Jan.

I assume I'll need to clear the cache. Any estimate as to how long this might take? Otherwise I'll be worried during the whole process. Additionally, will the current guide be running while the cache is being rebuilt? Just want to make sure I won't miss any recordings.

Thanks again,
Jim L

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#4

Post by garyan2 » Sun Feb 03, 2019 6:46 pm

Sorry, you are right... I made assumptions on how you had installed epg123. The MMUI+ file is created using the "Create UI+ support file" option in the configuration GUI. With your installation location, it would be in the D:\epg123\output folder.

The cache folder is strictly used by epg123 during the update and will have no impact on the existing guide in WMC. I've been experimenting right now to try and gauge how big an issue the slowdown is. The amount of time it will take depends on how many stations you download, how many days, and if you have enabled to use themoviedb.org for any missing movie coverart. I would estimate around 6 minutes for every 5000 programs. If you look at the trace.log file on 31 Jan for when you last successfully updated the MXF file, you will see an entry of how many programs were downloaded.

EDIT: I sent an email to Schedules Direct earlier and it looks like they just took down/rebooted their servers. Might have to give it some time before they are back up?
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

bomberjim

Posts: 13
Joined: Sat Jul 18, 2015 9:15 pm
Location:

HTPC Specs: Show details

#5

Post by bomberjim » Sun Feb 03, 2019 6:51 pm

Thanks again, I really appreciate the quick replies. I'll give it an hour before I clear the cache and let you know what happens.

Jim L.

RyC

Posts: 691
Joined: Tue Aug 21, 2012 10:21 pm
Location:

HTPC Specs: Show details

#6

Post by RyC » Sun Feb 03, 2019 8:11 pm

I seem to be getting the "Object reference not set to an instance of an object" error even after deleting the mmui json and clearing the cache. Do we just have to wait or is something else going on? I'm on the latest EPG123.

Code: Select all

[2/3/2019 12:06:18 PM] ===============================================================================
[2/3/2019 12:06:18 PM]  Beginning epg123 update execution. version 1.2.10.0
[2/3/2019 12:06:18 PM] ===============================================================================
[2/3/2019 12:06:18 PM] [ INFO] Beginning EPG123 update execution. 2019-02-03 20:06:18Z
[2/3/2019 12:06:18 PM] [ INFO] DaysToDownload: 14 , TheTVDBNumbers : False , PrefixEpisodeTitle: False , PrefixEpisodeDescription : False , AppendEpisodeDesc: True , OADOverride : True , TMDbCoverArt: True , IncludeSDLogos : False , AutoAddNew: True , CreateXmltv: False , ModernMediaUiPlusSupport: True
[2/3/2019 12:06:19 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 12:06:19 PM] [ INFO] Status request successful. account expires: 2019-02-18T07:24:47Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T15:03:41Z
[2/3/2019 12:06:19 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 12:06:20 PM] [ INFO] Successfully retrieved TMDb configurations.
[2/3/2019 12:06:20 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 12:06:20 PM] Entering buildLineupServices() for 1 lineups.
[2/3/2019 12:06:20 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-OR61925-X.
[2/3/2019 12:06:21 PM] Exiting buildLineupServices(). SUCCESS.
[2/3/2019 12:06:21 PM] Entering getAllScheduleEntryMd5s() for 14 days on 151 stations.
[2/3/2019 12:06:22 PM] [ INFO] Successfully retrieved Md5s for 151 station's daily schedules.
[2/3/2019 12:06:25 PM] [ INFO] Successfully retrieved 151 station's daily schedules.
[2/3/2019 12:06:37 PM] [ INFO] Found 0 cached daily schedules.
[2/3/2019 12:06:37 PM] [ INFO] Downloaded 2114 daily schedules.
[2/3/2019 12:06:37 PM] [ERROR] Unhandled exception caught from epg123.exe. message: Object reference not set to an instance of an object.
[2/3/2019 12:06:41 PM] ===============================================================================
[2/3/2019 12:06:41 PM]  Beginning epg123 client execution. version 1.2.10.0
[2/3/2019 12:06:41 PM] ===============================================================================
[2/3/2019 12:06:41 PM] [ INFO] Beginning epg123 client execution. 2019-02-03 20:06:41Z
[2/3/2019 12:06:41 PM] [ INFO] Import: True , Match: True , NoLogo: False , Force: False , ShowProgress: False
[2/3/2019 12:06:43 PM] Entering importMxfFile() for file "c:\epg123\output\epg123.mxf"
[2/3/2019 12:07:15 PM] [ INFO] Successfully imported .mxf file into Media Center database. Exit code: 0
[2/3/2019 12:07:15 PM] Exiting importMxfFile(). SUCCESS.
[2/3/2019 12:07:17 PM] [ INFO] Completed the automatch of lineup stations to tuner channels.
[2/3/2019 12:07:17 PM] [ INFO] Completed lineup refresh.
[2/3/2019 12:07:17 PM] Entering runWmcTask(ReindexSearchRoot)
[2/3/2019 12:07:17 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\ReindexSearchRoot".
[2/3/2019 12:07:17 PM] [ INFO] Successfully started the ReindexSearchRoot task. Exit code: 0
[2/3/2019 12:07:17 PM] Exiting runWmcTask(ReindexSearchRoot). SUCCESS.
[2/3/2019 12:07:17 PM] Entering runWmcTask(PvrScheduleTask)
[2/3/2019 12:07:17 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\PvrScheduleTask".
[2/3/2019 12:07:17 PM] [ INFO] Successfully started the PvrScheduleTask task. Exit code: 0
[2/3/2019 12:07:17 PM] Exiting runWmcTask(PvrScheduleTask). SUCCESS.
[2/3/2019 12:07:17 PM] [ERROR] The MXF file imported is 75.07 hours old.
[2/3/2019 12:07:17 PM] [ INFO] Completed EPG123 client execution.
[2/3/2019 12:07:17 PM] [ INFO] EPG123 client execution time was 00:00:35.6400385.

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#7

Post by garyan2 » Sun Feb 03, 2019 9:31 pm

@bomberjim & @RyC : It looks like this may be all cleared up soon. We noticed there was a significant slow down in response from SD for program updates and reported it to SD. Troubleshooting was in earnest the last few hours and it appears they have found the issue. Just to compare ... a 5000 program request was taking just over 2 minutes and after a fix was reduced back down to around 5 seconds. This is on par with what we were getting prior to 31 Jan. I am seeing less reports of time discontinuities in the trace.log file as well.

I haven't heard back whether SD has declared a permanent fix yet, but everything is looking good right now. It will probably take a day for everything to get back in line.

@RyC : I just downloaded your entire lineup for the next 14 days without issue. When you want to try again, you may want to clear your cache again.
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

bomberjim

Posts: 13
Joined: Sat Jul 18, 2015 9:15 pm
Location:

HTPC Specs: Show details

#8

Post by bomberjim » Sun Feb 03, 2019 10:04 pm

Just checked in after clearing the cache and running an update and was getting a new error. The update failed again. The errors:

1.) unhandeled exception caught from epg.123.exe message: access to path 'Global\{BAECOA11-437B-4D39-A2FA-DB568C973E3} is denied.
2.) The object not set to a reference message
3.) message number 1 was repeated
4.) The MXF file imported is 76.81 hours old.

My cache file went from nearly 60,000 items to only 6612 items.

I'm going to clear the cache and try again based on your post. Anything else I should worry about? How do I post code as RyC did?

Thanks
Jim L.

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#9

Post by garyan2 » Sun Feb 03, 2019 10:14 pm

Well that's a new one (#1). Sounds like a permission problem, but that GUID is the GUID for epg123.exe. It doesn't have permission to access itself?

To insert code like RyC did, click the "</>" button in the 'Full Editor & Preview' form when you post a reply.
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#10

Post by garyan2 » Sun Feb 03, 2019 10:17 pm

Oh, and please, @bomberjim, post the contents of the log file for the failed update so I can see where it is happening.
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

bomberjim

Posts: 13
Joined: Sat Jul 18, 2015 9:15 pm
Location:

HTPC Specs: Show details

#11

Post by bomberjim » Sun Feb 03, 2019 10:39 pm

It failed again but the errors are back to "normal" at least. My cache is still only 6612 items. Here is the latest log. So I assume wait a day or so to see what happens?????

Code: Select all

[2/3/2019 3:12:52 PM] ===============================================================================
[2/3/2019 3:12:52 PM]  Activating the epg123 configuration GUI. version 1.2.10.0
[2/3/2019 3:12:52 PM] ===============================================================================
[2/3/2019 3:12:54 PM] [ INFO] Successfully queried the Task Scheduler for status. Ready. Last Run 2/3/2019 12:58:22 PM; Exit: 0x00000000
[2/3/2019 3:12:55 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 3:12:55 PM] [ INFO] Status request successful. account expires: 2019-09-12T19:15:37Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T15:03:41Z
[2/3/2019 3:12:55 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 3:12:55 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 3:12:55 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 3:13:37 PM] ===============================================================================
[2/3/2019 3:13:37 PM]  Beginning epg123 update execution. version 1.2.10.0
[2/3/2019 3:13:37 PM] ===============================================================================
[2/3/2019 3:13:37 PM] [ INFO] Beginning EPG123 update execution. 2019-02-03 22:13:37Z
[2/3/2019 3:13:37 PM] [ INFO] DaysToDownload: 21 , TheTVDBNumbers : True , PrefixEpisodeTitle: True , PrefixEpisodeDescription : True , AppendEpisodeDesc: True , OADOverride : True , TMDbCoverArt: True , IncludeSDLogos : True , AutoAddNew: True , CreateXmltv: False , ModernMediaUiPlusSupport: False
[2/3/2019 3:13:37 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 3:13:38 PM] [ INFO] Status request successful. account expires: 2019-09-12T19:15:37Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T15:03:41Z
[2/3/2019 3:13:38 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 3:13:38 PM] [ INFO] Successfully retrieved TMDb configurations.
[2/3/2019 3:13:38 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 3:13:38 PM] Entering buildLineupServices() for 1 lineups.
[2/3/2019 3:13:38 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 3:13:40 PM] Exiting buildLineupServices(). SUCCESS.
[2/3/2019 3:13:40 PM] Entering getAllScheduleEntryMd5s() for 21 days on 323 stations.
[2/3/2019 3:13:51 PM] [ INFO] Successfully retrieved Md5s for 238 station's daily schedules.
[2/3/2019 3:14:04 PM] [ INFO] Successfully retrieved 238 station's daily schedules.
[2/3/2019 3:14:53 PM] [ INFO] Successfully retrieved Md5s for 85 station's daily schedules.
[2/3/2019 3:14:58 PM] [ INFO] Successfully retrieved 85 station's daily schedules.
[2/3/2019 3:15:12 PM] [ INFO] Found 0 cached daily schedules.
[2/3/2019 3:15:12 PM] [ INFO] Downloaded 6612 daily schedules.
[2/3/2019 3:15:12 PM] [ERROR] Unhandled exception caught from epg123.exe. message: Object reference not set to an instance of an object.
[2/3/2019 3:15:50 PM] ===============================================================================
[2/3/2019 3:15:50 PM]  Beginning epg123 client execution. version 1.2.10.0
[2/3/2019 3:15:50 PM] ===============================================================================
[2/3/2019 3:15:50 PM] [ INFO] Beginning epg123 client execution. 2019-02-03 22:15:50Z
[2/3/2019 3:15:50 PM] [ INFO] Import: True , Match: False , NoLogo: False , Force: False , ShowProgress: False
[2/3/2019 3:15:51 PM] Entering importMxfFile() for file "d:\epg123\output\epg123.mxf"
[2/3/2019 3:18:25 PM] [ INFO] Successfully imported .mxf file into Media Center database. Exit code: 0
[2/3/2019 3:18:25 PM] Exiting importMxfFile(). SUCCESS.
[2/3/2019 3:18:25 PM] [ INFO] Completed lineup refresh.
[2/3/2019 3:18:25 PM] Entering runWmcTask(ReindexSearchRoot)
[2/3/2019 3:18:25 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\ReindexSearchRoot".
[2/3/2019 3:18:25 PM] [ INFO] Successfully started the ReindexSearchRoot task. Exit code: 0
[2/3/2019 3:18:25 PM] Exiting runWmcTask(ReindexSearchRoot). SUCCESS.
[2/3/2019 3:18:25 PM] Entering runWmcTask(PvrScheduleTask)
[2/3/2019 3:18:25 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\PvrScheduleTask".
[2/3/2019 3:18:25 PM] [ INFO] Successfully started the PvrScheduleTask task. Exit code: 0
[2/3/2019 3:18:25 PM] Exiting runWmcTask(PvrScheduleTask). SUCCESS.
[2/3/2019 3:18:25 PM] [ERROR] The MXF file imported is 79.04 hours old.
[2/3/2019 3:18:25 PM] [ INFO] Completed EPG123 client execution.
[2/3/2019 3:18:25 PM] [ INFO] EPG123 client execution time was 00:02:34.9078602.
Thanks again
Jim L

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#12

Post by garyan2 » Sun Feb 03, 2019 11:00 pm

bomberjim wrote:
Sun Feb 03, 2019 10:39 pm
It failed again but the errors are back to "normal" at least. My cache is still only 6612 items. Here is the latest log. So I assume wait a day or so to see what happens?????

Code: Select all

[2/3/2019 3:12:52 PM] ===============================================================================
[2/3/2019 3:12:52 PM]  Activating the epg123 configuration GUI. version 1.2.10.0
[2/3/2019 3:12:52 PM] ===============================================================================
[2/3/2019 3:12:54 PM] [ INFO] Successfully queried the Task Scheduler for status. Ready. Last Run 2/3/2019 12:58:22 PM; Exit: 0x00000000
[2/3/2019 3:12:55 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 3:12:55 PM] [ INFO] Status request successful. account expires: 2019-09-12T19:15:37Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T15:03:41Z
[2/3/2019 3:12:55 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 3:12:55 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 3:12:55 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 3:13:37 PM] ===============================================================================
[2/3/2019 3:13:37 PM]  Beginning epg123 update execution. version 1.2.10.0
[2/3/2019 3:13:37 PM] ===============================================================================
[2/3/2019 3:13:37 PM] [ INFO] Beginning EPG123 update execution. 2019-02-03 22:13:37Z
[2/3/2019 3:13:37 PM] [ INFO] DaysToDownload: 21 , TheTVDBNumbers : True , PrefixEpisodeTitle: True , PrefixEpisodeDescription : True , AppendEpisodeDesc: True , OADOverride : True , TMDbCoverArt: True , IncludeSDLogos : True , AutoAddNew: True , CreateXmltv: False , ModernMediaUiPlusSupport: False
[2/3/2019 3:13:37 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 3:13:38 PM] [ INFO] Status request successful. account expires: 2019-09-12T19:15:37Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T15:03:41Z
[2/3/2019 3:13:38 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 3:13:38 PM] [ INFO] Successfully retrieved TMDb configurations.
[2/3/2019 3:13:38 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 3:13:38 PM] Entering buildLineupServices() for 1 lineups.
[2/3/2019 3:13:38 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 3:13:40 PM] Exiting buildLineupServices(). SUCCESS.
[2/3/2019 3:13:40 PM] Entering getAllScheduleEntryMd5s() for 21 days on 323 stations.
[2/3/2019 3:13:51 PM] [ INFO] Successfully retrieved Md5s for 238 station's daily schedules.
[2/3/2019 3:14:04 PM] [ INFO] Successfully retrieved 238 station's daily schedules.
[2/3/2019 3:14:53 PM] [ INFO] Successfully retrieved Md5s for 85 station's daily schedules.
[2/3/2019 3:14:58 PM] [ INFO] Successfully retrieved 85 station's daily schedules.
[2/3/2019 3:15:12 PM] [ INFO] Found 0 cached daily schedules.
[2/3/2019 3:15:12 PM] [ INFO] Downloaded 6612 daily schedules.
[2/3/2019 3:15:12 PM] [ERROR] Unhandled exception caught from epg123.exe. message: Object reference not set to an instance of an object.
[2/3/2019 3:15:50 PM] ===============================================================================
[2/3/2019 3:15:50 PM]  Beginning epg123 client execution. version 1.2.10.0
[2/3/2019 3:15:50 PM] ===============================================================================
[2/3/2019 3:15:50 PM] [ INFO] Beginning epg123 client execution. 2019-02-03 22:15:50Z
[2/3/2019 3:15:50 PM] [ INFO] Import: True , Match: False , NoLogo: False , Force: False , ShowProgress: False
[2/3/2019 3:15:51 PM] Entering importMxfFile() for file "d:\epg123\output\epg123.mxf"
[2/3/2019 3:18:25 PM] [ INFO] Successfully imported .mxf file into Media Center database. Exit code: 0
[2/3/2019 3:18:25 PM] Exiting importMxfFile(). SUCCESS.
[2/3/2019 3:18:25 PM] [ INFO] Completed lineup refresh.
[2/3/2019 3:18:25 PM] Entering runWmcTask(ReindexSearchRoot)
[2/3/2019 3:18:25 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\ReindexSearchRoot".
[2/3/2019 3:18:25 PM] [ INFO] Successfully started the ReindexSearchRoot task. Exit code: 0
[2/3/2019 3:18:25 PM] Exiting runWmcTask(ReindexSearchRoot). SUCCESS.
[2/3/2019 3:18:25 PM] Entering runWmcTask(PvrScheduleTask)
[2/3/2019 3:18:25 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\PvrScheduleTask".
[2/3/2019 3:18:25 PM] [ INFO] Successfully started the PvrScheduleTask task. Exit code: 0
[2/3/2019 3:18:25 PM] Exiting runWmcTask(PvrScheduleTask). SUCCESS.
[2/3/2019 3:18:25 PM] [ERROR] The MXF file imported is 79.04 hours old.
[2/3/2019 3:18:25 PM] [ INFO] Completed EPG123 client execution.
[2/3/2019 3:18:25 PM] [ INFO] EPG123 client execution time was 00:02:34.9078602.
Thanks again
Jim L
I've downloaded your entire lineup (21 days on 328 stations) and didn't have an issue. Try to clear the cache again and make sure your D:\epg123\cache folder is empty before trying again. It may be that the file that is causing you problems would not delete.

Are there any errors in your log file like this "[ERROR] Failed to delete all files from the cache folder."?
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

bomberjim

Posts: 13
Joined: Sat Jul 18, 2015 9:15 pm
Location:

HTPC Specs: Show details

#13

Post by bomberjim » Mon Feb 04, 2019 1:18 am

I deleted the cache, checked and made sure the cache file was empty (it was). Then I rebooted the computer (just because) and initiated an update. It failed again in the same manner as last time. No, there are no other errors such as failure to clear the cache. Here's the log.

Code: Select all

[2/3/2019 4:46:09 PM] ===============================================================================
[2/3/2019 4:46:09 PM]  Activating the epg123 configuration GUI. version 1.2.10.0
[2/3/2019 4:46:09 PM] ===============================================================================
[2/3/2019 4:46:11 PM] [ INFO] Successfully queried the Task Scheduler for status. Ready. Last Run 2/3/2019 4:35:01 PM; Exit: 0x00000000
[2/3/2019 4:46:11 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 4:46:12 PM] [ INFO] Status request successful. account expires: 2019-09-12T19:15:37Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T22:37:03Z
[2/3/2019 4:46:12 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 4:46:12 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 4:46:12 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 4:47:14 PM] ===============================================================================
[2/3/2019 4:47:14 PM]  Activating the epg123 configuration GUI. version 1.2.10.0
[2/3/2019 4:47:14 PM] ===============================================================================
[2/3/2019 4:47:15 PM] [ INFO] Successfully queried the Task Scheduler for status. Ready. Last Run 2/3/2019 4:35:01 PM; Exit: 0x00000000
[2/3/2019 4:47:15 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 4:47:15 PM] [ INFO] Status request successful. account expires: 2019-09-12T19:15:37Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T22:37:03Z
[2/3/2019 4:47:15 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 4:47:16 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 4:47:16 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 4:48:19 PM] ===============================================================================
[2/3/2019 4:48:19 PM]  Beginning epg123 update execution. version 1.2.10.0
[2/3/2019 4:48:19 PM] ===============================================================================
[2/3/2019 4:48:20 PM] [ INFO] Beginning EPG123 update execution. 2019-02-03 23:48:20Z
[2/3/2019 4:48:20 PM] [ INFO] DaysToDownload: 21 , TheTVDBNumbers : True , PrefixEpisodeTitle: True , PrefixEpisodeDescription : True , AppendEpisodeDesc: True , OADOverride : True , TMDbCoverArt: True , IncludeSDLogos : True , AutoAddNew: True , CreateXmltv: False , ModernMediaUiPlusSupport: False
[2/3/2019 4:48:20 PM] [ INFO] Token request successful. serverID: 20141201.web.1
[2/3/2019 4:48:21 PM] [ INFO] Status request successful. account expires: 2019-09-12T19:15:37Z , lineups: 1/4 , lastDataUpdate: 2019-02-03T22:37:03Z
[2/3/2019 4:48:21 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 4:48:21 PM] [ INFO] Successfully retrieved TMDb configurations.
[2/3/2019 4:48:21 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 4:48:21 PM] Entering buildLineupServices() for 1 lineups.
[2/3/2019 4:48:21 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 4:48:23 PM] Exiting buildLineupServices(). SUCCESS.
[2/3/2019 4:48:23 PM] Entering getAllScheduleEntryMd5s() for 21 days on 323 stations.
[2/3/2019 4:48:25 PM] [ INFO] Successfully retrieved Md5s for 238 station's daily schedules.
[2/3/2019 4:48:31 PM] [ INFO] Successfully retrieved 238 station's daily schedules.
[2/3/2019 4:49:16 PM] [ INFO] Successfully retrieved Md5s for 85 station's daily schedules.
[2/3/2019 4:49:19 PM] [ INFO] Successfully retrieved 85 station's daily schedules.
[2/3/2019 4:49:31 PM] [ INFO] Found 0 cached daily schedules.
[2/3/2019 4:49:31 PM] [ INFO] Downloaded 6612 daily schedules.
[2/3/2019 4:49:31 PM] [ERROR] Unhandled exception caught from epg123.exe. message: Object reference not set to an instance of an object.
[2/3/2019 4:50:13 PM] ===============================================================================
[2/3/2019 4:50:13 PM]  Beginning epg123 client execution. version 1.2.10.0
[2/3/2019 4:50:13 PM] ===============================================================================
[2/3/2019 4:50:13 PM] [ INFO] Beginning epg123 client execution. 2019-02-03 23:50:13Z
[2/3/2019 4:50:13 PM] [ INFO] Import: True , Match: False , NoLogo: False , Force: False , ShowProgress: False
[2/3/2019 4:50:14 PM] Entering importMxfFile() for file "d:\epg123\output\epg123.mxf"
[2/3/2019 4:54:10 PM] [ INFO] Successfully imported .mxf file into Media Center database. Exit code: 0
[2/3/2019 4:54:10 PM] Exiting importMxfFile(). SUCCESS.
[2/3/2019 4:54:11 PM] [ INFO] Completed lineup refresh.
[2/3/2019 4:54:11 PM] Entering runWmcTask(ReindexSearchRoot)
[2/3/2019 4:54:11 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\ReindexSearchRoot".
[2/3/2019 4:54:11 PM] [ INFO] Successfully started the ReindexSearchRoot task. Exit code: 0
[2/3/2019 4:54:11 PM] Exiting runWmcTask(ReindexSearchRoot). SUCCESS.
[2/3/2019 4:54:11 PM] Entering runWmcTask(PvrScheduleTask)
[2/3/2019 4:54:11 PM] [ INFO] SUCCESS: Attempted to run the scheduled task "Microsoft\Windows\Media Center\PvrScheduleTask".
[2/3/2019 4:54:11 PM] [ INFO] Successfully started the PvrScheduleTask task. Exit code: 0
[2/3/2019 4:54:11 PM] Exiting runWmcTask(PvrScheduleTask). SUCCESS.
[2/3/2019 4:54:11 PM] [ERROR] The MXF file imported is 80.64 hours old.
[2/3/2019 4:54:11 PM] [ INFO] Completed EPG123 client execution.
[2/3/2019 4:54:11 PM] [ INFO] EPG123 client execution time was 00:03:58.1046188.
thanks again for your help.
Jim L.

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#14

Post by garyan2 » Mon Feb 04, 2019 1:33 am

I don't understand. Here is my result:

Code: Select all

[2/3/2019 6:27:37 PM] ===============================================================================
[2/3/2019 6:27:37 PM]  Beginning epg123 update execution. version 1.2.10.0
[2/3/2019 6:27:37 PM] ===============================================================================
[2/3/2019 6:27:37 PM] [ INFO] Beginning EPG123 update execution. 2019-02-04 01:27:37Z
[2/3/2019 6:27:37 PM] [ INFO] DaysToDownload: 21 , TheTVDBNumbers : True , PrefixEpisodeTitle: True , PrefixEpisodeDescription : True , AppendEpisodeDesc: True , OADOverride : True , TMDbCoverArt: True , IncludeSDLogos : True , AutoAddNew: True , CreateXmltv: False , ModernMediaUiPlusSupport: False
[2/3/2019 6:27:37 PM] [ INFO] Status request successful. account expires: 2019-10-01T13:29:42Z , lineups: 1/255 , lastDataUpdate: 2019-02-03T22:37:03Z
[2/3/2019 6:27:37 PM] [ INFO] system status: Online , message: No known issues.
[2/3/2019 6:27:37 PM] [ INFO] Successfully retrieved TMDb configurations.
[2/3/2019 6:27:37 PM] [ INFO] Successfully requested listing of client lineups from Schedules Direct.
[2/3/2019 6:27:38 PM] Entering buildLineupServices() for 1 lineups.
[2/3/2019 6:27:38 PM] [ INFO] Successfully retrieved the station mapping for lineup USA-SD02227-X.
[2/3/2019 6:28:15 PM] Exiting buildLineupServices(). SUCCESS.
[2/3/2019 6:28:15 PM] Entering getAllScheduleEntryMd5s() for 21 days on 328 stations.
[2/3/2019 6:28:17 PM] [ INFO] Successfully retrieved Md5s for 238 station's daily schedules.
[2/3/2019 6:28:21 PM] [ INFO] Successfully retrieved 209 station's daily schedules.
[2/3/2019 6:28:31 PM] [ INFO] Successfully retrieved Md5s for 90 station's daily schedules.
[2/3/2019 6:28:32 PM] [ INFO] Successfully retrieved 81 station's daily schedules.
[2/3/2019 6:28:32 PM] [ INFO] Found 3993 cached daily schedules.
[2/3/2019 6:28:32 PM] [ INFO] Downloaded 2655 daily schedules.
[2/3/2019 6:28:42 PM] [ INFO] Time discontinuity detected. Service 10051 (BET) SH012857740000 (entry 563) ends at 2019-02-21 02:00:00Z, SH024995750000 (entry 564) starts at 2019-02-21 00:00:00Z.
[2/3/2019 6:28:42 PM]         No further discontinuities on BET will be reported for 2019-02-21.
[2/3/2019 6:28:43 PM] [ INFO] Time discontinuity detected. Service 21883 (BOOM) SH012857740000 (entry 627) ends at 2019-02-21 02:00:00Z, SH000045050000 (entry 628) starts at 2019-02-21 00:00:00Z.
[2/3/2019 6:28:43 PM]         No further discontinuities on BOOM will be reported for 2019-02-21.
[2/3/2019 6:28:49 PM] [ INFO] Time discontinuity detected. Service 18715 (TR3S) SH012857740000 (entry 318) ends at 2019-02-21 04:00:00Z, SH030625720000 (entry 319) starts at 2019-02-21 00:00:00Z.
[2/3/2019 6:28:49 PM]         No further discontinuities on TR3S will be reported for 2019-02-21.
[2/3/2019 6:28:58 PM] [ INFO] Time discontinuity detected. Service 24575 (HBOLATP) SH012857740000 (entry 304) ends at 2019-02-21 02:00:00Z, SH004925520000 (entry 305) starts at 2019-02-21 00:10:00Z.
[2/3/2019 6:28:58 PM]         No further discontinuities on HBOLATP will be reported for 2019-02-21.
[2/3/2019 6:29:01 PM] [ INFO] Processed 6648 daily schedules for 328 stations.
[2/3/2019 6:29:01 PM] Exiting getAllScheduleEntryMd5s(). SUCCESS.
[2/3/2019 6:29:01 PM] Entering buildAllProgramEntries() for 37378 programs.
[2/3/2019 6:29:45 PM] [ INFO] Found 35254 cached program descriptions.
[2/3/2019 6:29:47 PM] [ INFO] Successfully retrieved 2124 program descriptions.
[2/3/2019 6:29:50 PM] [ INFO] Processed 37378 program descriptions.
[2/3/2019 6:29:50 PM] Exiting buildAllProgramEntries(). SUCCESS.
[2/3/2019 6:29:50 PM] Entering buildAllGenericSeriesInfoDescriptions() for 4528 series.
[2/3/2019 6:29:52 PM] [ INFO] Found 4053 cached series descriptions.
[2/3/2019 6:29:53 PM] [ INFO] Successfully retrieved 475 generic program descriptions.
[2/3/2019 6:29:53 PM] [ INFO] Processed 4528 series descriptions.
[2/3/2019 6:29:53 PM] Exiting buildAllGenericSeriesInfoDescriptions(). SUCCESS.
[2/3/2019 6:29:53 PM] Entering getAllMoviePosters() for 3138 movies.
[2/3/2019 6:29:54 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:29:54 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:29:55 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:29:56 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:29:57 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:29:57 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:29:58 PM] [ INFO] Successfully retrieved artwork info for 138 programs.
[2/3/2019 6:30:02 PM] [ INFO] TMDb catalog search for "Once Upon a Prince" from 2018 found 1 results.
[2/3/2019 6:30:02 PM] [ INFO] TMDb catalog search for "Falling Stars" from 2019 found 1 results.
[2/3/2019 6:30:04 PM] [ INFO] TMDb catalog search for "El bruto" from 2002 found 0 results.
[2/3/2019 6:30:04 PM] [ INFO] TMDb catalog search for "El bruto" from 2001 found 0 results.
[2/3/2019 6:30:04 PM] [ INFO] TMDb catalog search for "El bruto" from 2003 found 0 results.
[2/3/2019 6:30:05 PM] [ INFO] TMDb catalog search for "La bruja" from 2015 found 2 results.
[2/3/2019 6:30:05 PM] [ INFO] Processed 3138 movie poster links.
[2/3/2019 6:30:05 PM] Exiting getAllMoviePosters(). SUCCESS.
[2/3/2019 6:30:05 PM] Entering getAllSeriesImages() for 4528 series.
[2/3/2019 6:30:05 PM] [ INFO] Found 0 cached series image links.
[2/3/2019 6:30:06 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:06 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:07 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:08 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:10 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:10 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:10 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:12 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:12 PM] [ INFO] Successfully retrieved artwork info for 500 programs.
[2/3/2019 6:30:13 PM] [ INFO] Successfully retrieved artwork info for 28 programs.
[2/3/2019 6:30:15 PM] [ INFO] Processed 4528 series image links.
[2/3/2019 6:30:15 PM] Exiting getAllSeriesImages(). SUCCESS.
[2/3/2019 6:30:16 PM] [ INFO] Completed compiling keywords and keyword groups.
[2/3/2019 6:30:20 PM] [ INFO] Completed save of the MXF file to "C:\epg123\output\epg123.mxf".
[2/3/2019 6:30:20 PM] [ INFO] Completed save of image archive file to "C:\epg123\guideImages.xml".
[2/3/2019 6:30:34 PM] [ INFO] 28944 files deleted from the cache directory during cleanup.
[2/3/2019 6:30:34 PM] [ INFO] Generated .mxf file contains 328 services, 4528 series, 37378 programs, and 56463 people with 7767 image links.
[2/3/2019 6:30:34 PM] [ INFO] Completed EPG123 update execution. SUCCESS.
[2/3/2019 6:30:34 PM] [ INFO] epg123 update execution time was 00:02:57.2968750.
Did something on your system change? Did your user lose the rights to read from the cache folder?
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

bomberjim

Posts: 13
Joined: Sat Jul 18, 2015 9:15 pm
Location:

HTPC Specs: Show details

#15

Post by bomberjim » Mon Feb 04, 2019 3:16 am

Nothing changed that I'm aware of. The program was working fine through the 31st. I don't think I've lost any rights to read the cache file. I know that on my 4pm update (when the cache wasn't cleared) it saw 6612 cached schedules. It also writes 6612 files to the cached folder everytime it updates after clearing the cache. These two facts would seem to indicate that it has no problems reading or writing to the cache.

Where do we go from here?

Jim L

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#16

Post by garyan2 » Mon Feb 04, 2019 3:50 am

I'm looking through my code to see if there is anything to help in pinpointing where you are having problems. In the mean time, could you download the portable zip file and unzip to a temporary location on the C drive... run that epg123.exe and just try to create the MXF file. You will need to INCLUDE the lineup for download, select all stations for 21 days, and [Save & Execute]. See if it fails from there.

I will start working on an engineering build to give us some more information on what may be going on. What I find interesting is that it is taking 42 seconds after your exception error before it start the client. I would think it would be sooner than that.

Also, even though EPG123 is writing the files to the cache folder, where the error is occurring is when it tries to open all those files and read the contents.
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#17

Post by garyan2 » Mon Feb 04, 2019 4:27 am

If you run it as administrator, does it still fail?
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

User avatar
garyan2

Posts: 3333
Joined: Fri Nov 27, 2015 7:23 pm
Location:

HTPC Specs: Show details

#18

Post by garyan2 » Mon Feb 04, 2019 4:44 am

It appears that your failed run is from the Scheduled Task, is that correct? If you run from the configuration GUI by clicking the [Save & Execute], does it work then?
- Gary
Stomping out the Rovi disease, one media center at a time. http://epg123.garyan2.net

vaporE

Posts: 2
Joined: Mon Feb 04, 2019 6:14 am
Location:

HTPC Specs: Show details

#19

Post by vaporE » Mon Feb 04, 2019 6:22 am

I also have this same exact issue. Jan 31st was the last time mine ran. Scheduled task says it is successful but I have the unhandled exception just like bomberjim. No known changes to my Win7 setup. I did not install initially and have always used portable zip file.

I did try to click save & execute from gui (not client) and it appeared to not do anything.

I'm mobile right now but will be able to copy logs in the morning when I get back to my computer, both of gui save & execute and scheduled task runs.

adam1991

Posts: 2605
Joined: Sat Jun 11, 2011 2:31 pm
Location:

HTPC Specs: Show details

#20

Post by adam1991 » Mon Feb 04, 2019 11:30 am

Gary, it's not you. I'm running a slightly older version of your software, and all was well except for 3am EST today. The log file showed a SD server error 500, therefore no new data came in and my mxf file was 24.01 hours old.

I just now ran it, 3 hours later at 0625, and all is green and well.

Post Reply