Daily Usenet report for news.ripco.com

Feb 22 00:01:02 -- Feb 22 23:58:03

Unknown entries from news log file:

First 5 / 5 lines (100.0%)

Feb 22 08:42:35 remote5bge0 overchan[21449]: [ID 702911 news.error] input line too long, skipping
Feb 22 12:39:25 remote5bge0 overchan[21449]: [ID 702911 news.error] input line too long, skipping
Feb 22 13:45:53 remote5bge0 overchan[21449]: [ID 702911 news.error] input line too long, skipping
Feb 22 13:54:52 remote5bge0 overchan[21449]: [ID 702911 news.error] input line too long, skipping
Feb 22 16:58:02 remote5bge0 overchan[21449]: [ID 702911 news.error] input line too long, skipping

Log entries by program:

Program nameLines%LinesSize%Size
innd 18647 32.9%2.9 MB 34.3%
inn 17591 31.0%3.1 MB 36.3%
nnrpd 17110 30.2%1.8 MB 21.0%
innfeed 3332 5.9%729.9 KB 8.4%
overchan 5 0.0%0.7 KB 0.0%
controlchan 2 0.0%0.2 KB 0.0%
TOTAL: 6 56687 100.0%8.5 MB100.0%

History cache:

ReasonCount%Count
Do not exist 147742 52.3%
Cache misses 134926 47.7%
Negative hits 0 0.0%
Positive hits 0 0.0%
TOTAL: 4 282668 100.0%

INND timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article cancel00:00:00.000 0.0%188 0.000 0.000 0.000
article cleanup00:00:00.328 0.0%34878 0.000 0.009 0.060
article logging00:00:00.464 0.0%35256 0.000 0.013 0.061
article parse00:00:01.368 0.0%89264 0.000 0.015 0.037
article write00:00:58.848 0.0%25896 0.962 2.272 46.209
artlog/artparse00:00:00.000 0.0%16 0.000 0.000 0.000
data move00:00:00.214 0.0%295836 0.000 0.001 0.004
hishave/artparse00:00:00.000 0.0%16 0.000 0.000 0.000
history grep00:00:00.000 0.0%0 0.000 0.000 0.000
history lookup00:00:02.166 0.0%283982 0.002 0.008 0.019
history sync00:00:00.148 0.0%802 0.000 0.185 1.000
history write00:00:02.384 0.0%34878 0.015 0.068 0.589
hiswrite/artparse00:00:00.000 0.0%16 0.000 0.000 0.000
idle47:59:47.360 99.9%330850 239.818 522.253 1321.822
nntp read00:00:01.990 0.0%330242 0.000 0.006 0.012
overview write00:00:00.176 0.0%25896 0.000 0.007 0.047
perl filter00:00:50.614 0.0%34878 1.114 1.451 3.269
python filter00:00:00.914 0.0%34880 0.000 0.026 0.068
site send00:00:01.524 0.0%77640 0.000 0.020 0.048
TOTAL: 48:02:16.04848:01:48.498100.0%----

INNfeed timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
article new00:00:00.412 0.0%25988 0.000 0.016 0.057
article prepare00:00:00.016 0.0%35360 0.000 0.000 0.013
article read00:00:00.556 0.0%5430 0.000 0.102 10.286
backlog stats00:00:00.160 0.0%337504 0.000 0.000 0.004
callbacks00:00:00.000 0.0%0 0.000 0.000 0.000
data read00:00:02.228 0.0%214422 0.002 0.010 0.026
data write00:00:03.466 0.0%188956 0.007 0.018 0.034
idle47:53:16.118100.0%337504 311.977 510.797 1160.509
status file00:00:01.318 0.0%354 0.000 3.723 31.000
TOTAL: 47:53:34.25447:53:24.274100.0%----

nnrpd timer:

Code regionTimePctInvokedMin(ms)Avg(ms)Max(ms)
idle01:48:12.756 98.9%17488 19.518 371.269 14867.065
newnews00:00:00.000 0.0%0 0.000 0.000 0.000
nntpwrite00:00:04.816 0.1%552972 0.000 0.009 0.046
readart00:00:18.084 0.3%1590 3.500 11.374 36.500
TOTAL: 01:49:22.60601:48:35.656 99.3%----

Control commands to INND:

CommandNumber
L 2
flush 2
go 4
logmode 2
mode 6
name 5
pause 2
paused 2
reserve 4
TOTAL: 9 29

Incoming Feeds (INN):

ServerConnectsOfferedTakenRefusedReject%AccptElapsed
1ripco-out.feed.uzoreto.com 1148 28218 7614 17438 3166 26%94:38:04
2news.snarked.org 44 24676 6646 17352 678 26%53:50:00
3feeder3.feed-ams.uzoreto.com 574 17312 6246 8744 2322 36%47:19:12
4newsfeed.neva.ru 614 33200 4330 27274 1596 13%272:43:22
5newsfeed.fu-berlin.de 6 14818 612 14170 36 4%59:21:18
6news-in.rahul.net 574 13116 222 12848 46 1%47:22:00
7news.lightlink.com 2 2470 66 2296 108 2%27:52:02
8ripco-out.feeder.erje.net 574 28108 50 27210 848 0%47:16:48
9news.cmpublishers.com 50 7020 36 6970 14 0%47:59:58
10localhost 148 2 2 0 0 100%00:00:00
TOTAL: 10 3734 168940 25824 134302 8814 15%698:22:44
Articles received by server

Incoming Volume (INN):

ServerAcceptVolDupVolRejVolTotalVol%AccVol/Art
1ripco-out.feed.uzoreto.com18.4 MB0.0 KB6.8 MB25.2 MB 72%2.4 KB
2news.snarked.org18.4 MB0.0 KB2.1 MB20.5 MB 89%2.9 KB
3feeder3.feed-ams.uzoreto.com15.0 MB0.0 KB5.5 MB20.5 MB 73%2.4 KB
4newsfeed.neva.ru14.7 MB0.0 KB4.1 MB18.7 MB 78%3.2 KB
5news-in.rahul.net7.9 MB0.0 KB1.4 MB9.3 MB 84%35.5 KB
6newsfeed.fu-berlin.de3.0 MB0.0 KB15.6 MB18.5 MB 16%29.3 KB
7news.lightlink.com919.1 KB0.0 KB4.2 MB5.1 MB 17%30.3 KB
8ripco-out.feeder.erje.net106.6 KB0.0 KB6.0 MB6.1 MB 1%6.9 KB
9news.cmpublishers.com76.9 KB0.0 KB57.6 KB134.4 KB 57%2.7 KB
10localhost4.1 KB0.0 KB0.0 KB4.1 KB100%2.1 KB
TOTAL: 1078.4 MB0.0 KB45.8 MB124.1 MB 63%3.7 KB
Incoming Volume received by server

Incoming articles:

DateArticles%ArtsArt/secSize%SizeKB/sec
Feb 22 00:01:02 - 00:59:59 252 2.0% 0.07735.1 KB 1.8% 0.21
Feb 22 01:00:00 - 01:59:59 359 2.8% 0.101021.7 KB 2.5% 0.28
Feb 22 02:00:00 - 02:59:59 442 3.4% 0.121.6 MB 4.2% 0.47
Feb 22 03:00:00 - 03:59:59 588 4.6% 0.161.6 MB 4.0% 0.45
Feb 22 04:00:00 - 04:59:59 513 4.0% 0.141.7 MB 4.3% 0.48
Feb 22 05:00:00 - 05:59:59 555 4.3% 0.151.5 MB 3.9% 0.44
Feb 22 06:00:00 - 06:59:59 592 4.6% 0.161.7 MB 4.3% 0.48
Feb 22 07:00:00 - 07:59:59 627 4.9% 0.171.5 MB 3.9% 0.43
Feb 22 08:00:00 - 08:59:59 666 5.2% 0.182.0 MB 5.1% 0.57
Feb 22 09:00:00 - 09:59:59 664 5.1% 0.181.7 MB 4.4% 0.49
Feb 22 10:00:00 - 10:59:59 774 6.0% 0.212.1 MB 5.4% 0.61
Feb 22 11:00:00 - 11:59:59 728 5.6% 0.201.8 MB 4.7% 0.52
Feb 22 12:00:00 - 12:59:59 780 6.0% 0.223.0 MB 7.6% 0.85
Feb 22 13:00:00 - 13:59:59 727 5.6% 0.202.0 MB 5.1% 0.57
Feb 22 14:00:00 - 14:59:59 681 5.3% 0.192.3 MB 5.9% 0.66
Feb 22 15:00:00 - 15:59:59 708 5.5% 0.201.7 MB 4.4% 0.49
Feb 22 16:00:00 - 16:59:59 507 3.9% 0.141.6 MB 4.1% 0.46
Feb 22 17:00:00 - 17:59:59 525 4.1% 0.151.8 MB 4.5% 0.50
Feb 22 18:00:00 - 18:59:59 484 3.8% 0.131.8 MB 4.6% 0.51
Feb 22 19:00:00 - 19:59:59 391 3.0% 0.111.2 MB 3.1% 0.35
Feb 22 20:00:00 - 20:59:59 353 2.7% 0.101.3 MB 3.3% 0.37
Feb 22 21:00:00 - 21:59:59 368 2.9% 0.101006.0 KB 2.5% 0.28
Feb 22 22:00:00 - 22:59:59 338 2.6% 0.091.4 MB 3.7% 0.41
Feb 22 23:00:00 - 23:58:03 282 2.2% 0.08989.9 KB 2.5% 0.28
TOTAL: 23:57:01 12904 100.0% 0.1539.2 MB 100.0% 0.47
Incoming articles
Incoming articles (size)

Sites sending bad articles:

ServerTotalGroupDistDuplicUnappTooOldSiteLineOther
1ripco-out.feed.uzoreto.com 1595 1244 0 0 1 0 0 0 350
2feeder3.feed-ams.uzoreto.com 1162 702 0 0 2 0 0 0 458
3newsfeed.neva.ru 841 313 0 0 1 0 0 0 527
4ripco-out.feeder.erje.net 425 410 0 0 0 0 0 0 15
5news.snarked.org 338 223 0 0 0 0 0 0 115
6news.lightlink.com 151 0 0 0 0 0 0 0 151
7newsfeed.fu-berlin.de 148 0 0 0 0 0 0 0 148
8news-in.rahul.net 23 2 0 0 0 0 0 0 21
9news.cmpublishers.com 4 4 0 0 0 0 0 0 0
TOTAL: 9 4687 2898 0 0 4 0 0 0 1785

Unwanted newsgroups [Top 20]:

NewsgroupCount
free.usenet 2158
alt.binaries.ftd 121
scot.general 59
free.ucp 52
perl.cpan.uploads 40
alt.binaries.pictures.rail 35
alt.binaries.nl 30
free.willey 21
alt.binaries.pictures.purebeauty 19
alt.binaries.backup 19
it.comp.os.win.windows7 16
free.it.scienza.fisica 15
alt.binaries.pictures.wallpaper 15
alt.binaries.e-book 14
it.tlc.cellulari.android 13
wales.test 13
alt.binaries.mac.games 11
de.rec.sf.startrek 10
alt.binaries.pictures.scenic 9
alt.binaries.nospam.breasts.natural 8
TOTAL: 127 2898

Supposedly-moderated groups with unmoderated postings [Top 20]:

GroupsCount
christnet.bible 2
christnet.theology 1
bit.listserv.catholic 1
TOTAL: 3 4

INND Perl filter [Top 20]:

ReasonCount
EMP (md5) 2174
Too many newsgroups 600
EMP (phl) 188
Binary in non-binary group 168
Scoring filter (8) 22
Scoring filter (9) 10
Scoring filter (10) 8
Scoring filter (11) 4
Scoring filter (13) 2
TOTAL: 9 3176

Miscellaneous innd statistics [Top 10]:

EventServerNumber
Bad Message-ID's offered
ripco-out.feeder.erje.net 20
feeder3.feed-ams.uzoreto.com 2
TOTAL: 2 22
Huge articles
newsfeed.fu-berlin.de 16
TOTAL: 1 16
Including strange strings
newsfeed.fu-berlin.de 134
newsfeed.neva.ru 42
ripco-out.feed.uzoreto.com 12
feeder3.feed-ams.uzoreto.com 1
TOTAL: 4 189
TOTAL: 3 227

Outgoing Feeds (innfeed) by Articles:

ServerOfferedTakenRefusedRejectMissSpool%TookElapsed
1feeder.erje.net 27798 2920 19916 1342 0 0 10%47:36:58
2news.lightlink.com 7842 1498 4240 12 0 8 19%47:40:02
3rahul.net 19596 524 10550 14 0 14 2%47:36:30
4news.cmpublishers.com 36042 176 23226 1968 0 46 0%47:40:02
5fu-berlin.de 23558 112 23446 0 0 0 0%47:50:16
6news.uzoreto.com 11726 54 11336 126 0 0 0%47:40:02
7newsfeed.neva.ru 21666 28 21314 18 0 0 0%47:38:28
8news.snarked.org 32688 20 18912 10 0 142 0%47:53:30
9remote6hme0.ripco.com 6 0 0 6 0 0 0%01:12:06
TOTAL: 9 180922 5332 132940 3496 0 210 2%382:47:54
Outgoing feeds (innfeed) by Articles

Outgoing Feeds (innfeed) by Volume:

ServerAcceptVolRejectVolTotalVolVolume/secVol/ArtElapsed
1feeder.erje.net7.8 MB3.2 MB11.0 MB0.1 KB/s2.6 KB47:36:58
2news.lightlink.com4.7 MB26.4 KB4.7 MB0.0 KB/s3.2 KB47:40:02
3rahul.net2.2 MB29.7 KB2.3 MB0.0 KB/s4.3 KB47:36:30
4fu-berlin.de1.9 MB0.0 KB1.9 MB0.0 KB/s17.4 KB47:50:16
5news.cmpublishers.com595.4 KB4.5 MB5.1 MB0.0 KB/s2.4 KB47:40:02
6news.uzoreto.com184.4 KB496.3 KB680.8 KB0.0 KB/s3.8 KB47:40:02
7news.snarked.org99.4 KB18.6 KB118.0 KB0.0 KB/s3.9 KB47:53:30
8newsfeed.neva.ru82.9 KB37.9 KB120.8 KB0.0 KB/s2.6 KB47:38:28
9remote6hme0.ripco.com0.0 KB21.2 KB21.2 KB0.0 KB/s3.5 KB01:12:06
TOTAL: 917.6 MB8.4 MB25.9 MB0.0 KB/s3.0 KB382:47:54
Outgoing feeds (innfeed) by Volume

NNRP readership statistics:

SystemConnArtsSizeGroupsPostRejElapsed
1ftupet.com 286 5861.5 MB 282 2 000:07:06
2shell3 6 4161.2 MB 46 0 001:42:09
TOTAL: 2 292 10022.7 MB 328 2 001:49:17

NNRP readership statistics (by domain):

SystemConnArtsSizeGroupsPostRejElapsed
1*.com 286 5861.5 MB 282 2 000:07:06
2? 6 4161.2 MB 46 0 001:42:09
TOTAL: 2 292 10022.7 MB 328 2 001:49:16

NNRP total resource statistics [Top 20]:

SystemUser(ms)System(ms)Idle(ms)Elapsed
shell3 2.160 2.152 0.00001:42:09
ftupet.com 43.544 7.642 0.00000:07:06
218.75.38.212 0.200 0.042 0.00000:00:00
192.241.218.175 0.202 0.044 0.00000:00:00
TOTAL: 4 46.106 9.880 0.00001:49:17

NNRP no permission clients:

SystemConn
192.241.218.175 2
218.75.38.212 2
TOTAL: 2 4

Newsgroup request counts (by category):

CategoryCountPct
1rec 774 77.2%
2alt 82 8.2%
3comp 62 6.2%
4misc 50 5.0%
5sci 16 1.6%
6chi 10 1.0%
7news 6 0.6%
8soc 2 0.2%
TOTAL: 8 1002100.0%

Newsgroup request counts (by newsgroup) [Top 100]:

NewsgroupCount
1rec.arts.tv 432
2rec.food.cooking 314
3alt.free.newsservers 60
4misc.phone.mobile.iphone 46
5comp.sys.mac.system 36
6sci.electronics.repair 16
7comp.mobile.ipad 10
8alt.security.alarms 10
9comp.security.ssh 8
10rec.audio.high-end 6
11rec.radio.broadcasting 6
12alt.battlestar-galactica 6
13chi.forsale 6
14rec.bicycles.tech 6
15rec.radio.swap 4
16chi.weather 4
17comp.protocols.dns.bind 4
18misc.consumers.frugal-living 4
19comp.sys.apple2 2
20soc.history.what-if 2
21rec.bicycles.misc 2
22news.admin.net-abuse.usenet 2
23alt.sports.football.pro.kc-chiefs 2
24alt.radio.pirate 2
25alt.bittorrent 2
26comp.internet.services.google 2
27rec.gardens.edible 2
28news.software.nntp 2
29rec.radio.scanner 2
30news.groups.questions 2
TOTAL: 30 1002