IPP Software Navigation Tools IPP Links Communication Pan-STARRS Links

Changes between Version 6 and Version 7 of ThroughputDemo_20091104


Ignore:
Timestamp:
Nov 6, 2009, 11:36:40 AM (17 years ago)
Author:
eugene
Comment:

--

Legend:

Unmodified
Added
Removed
Modified
  • ThroughputDemo_20091104

    v6 v7  
    11= Throughput Demonstration 2009.11.04 =
    22[[PageOutline]]
    3 
    4 == start @ 11:30am ==
    5 
    6 Bill, Heather & I have been running small-scale tests of the full
    7 processing -> distribution to ensure all of the steps are working.
    8 We've ironed out a few bugs and have a solid demonstration of the full
    9 sequence including automatic diffs, magic, destreak, and distribution.
    10 
    11 I've just (at 11:35) launched a full-scale throughput demonstration
    12 using 611 exposures.  These are 3pi exposures from July for the RA,DEC
    13 range 270.0 - 300.0, 0.0 - 20.0.  There are g,r,i exposures,
    14 supposedly all taken as TTI pairs.  Obviously, the fact that 611 is
    15 odd, and 612 is the closest multiple of 6, says that at least one is
    16 missing.
    17 
    18 I've also modified pantasks.pro (in ~ipp, not yet checked in) to fix
    19 the problem where we get paths of the form /data/any.0/foo/bar
    20 (something of a hack, I attempt to replace @HOST@.0 and @HOST@.1
    21 before doing just @HOST@).  This should help with nfs load during
    22 camera.
    23 
    24 === update 1 ===
    25 
    26 my fix to the camera paths had no effect: the paths are now of the form:
    27 
    28 {{{neb://any/gpc1/throughput.20091104/o4999g0217o.78668/o4999g0217o.78668.cm.29757.smf}}}
    29 
    30 but they are still all going to ipp039, who is getting quite a load.
    31 I'm going to remove it as a processing node so it can deal with the
    32 camera I/O.
    33 
    34 === update 2 ===
    35 
    36 we are having some trouble in this test because ipp039 is getting
    37 really slammed.
    38 
    39 the situation is that the 'any' neb host problem is affecting more
    40 than just camera: a number of every diff and warp run are also going
    41 to 'any', which means ipp039.  I'm checking into the cause, but it
    42 shows we need to fix this nebulous bug.
    43 
    44 === update 3 ===
    45 
    46 i found a bug in the skycell by host pantasks function that allowed
    47 the range to be larger than count, which in turn set a number of the
    48 target hosts and nebulous volumes to 'any'.  i've fixed this, so
    49 hopefully the load on ipp039 will fall again...
    50 
    51 == report @ 3pm ==
    52 
    53 looks like the fix I put in for this is now working: we have no
    54 skycells with path_base including 'any' since the fix, and the load on
    55 ipp039 has been mostly sensible since then as well.  there are
    56 probably still a few warps sitting there that are being used for
    57 diffs, so it will be elevated until those are done.
    58 
    59 the processing speed is looking mostly reasonable, except for the
    60 diff_skycells, which were heavily hit by the ipp039 collisions.  I'll
    61 be looking for those times to drop somewhat as well.
    62 
    63 So far, we are 3 hours into the test, and we have only processed 1/6
    64 of the chips (and somewhat less of the other stages).  Since the goal
    65 is 12 hours, we are running a bit behind.  I'm hopeful that the ipp039
    66 collisions account for most of the gap...
    67 
    68 == report @ 6pm ==
    69 
    70 It has been 6 hours now, and the chip and diff processing times are
    71 not much better than before.  We've only done about 30% of the data
    72 set, so it is still going slowly.  At this rate, it will be 20 hours
    73 before we finish this batch, which is kind of slow.  I'm going to
    74 change my plan and try to boost the number of hosts.
    75 
    76 At the moment, our limiting steps have used the following number of seconds:
    77 
    78 {{{
    79 chip: 1,021,709.35 sec
    80 warp: 610,303.59 sec
    81 diff: 540,536.4 sec
    82 destreak: 259,726 sec
    83 dist process: 177,430.2 sec
    84 camera: 69,067.08 sec
    85 }}}
    86 
    87 === update 1 ===
    88 
    89 oops.
    90 
    91 I just attempted to load another set of wave 2 nodes and got a
    92 segfault from pantasks...
    93 
    94 I'm going to wait 5 min for jobs to complete, and then I'll restart pantasks...
    95 
    96 === update 2 ===
    97 
    98 OK, I've restarted the stdscience pantasks, and I've bumped up the
    99 number of hosts to:
    100 
    101 1x1 3x2 4x3 4xC
    102 
    103 continuing to exclude ipp005 and ipp039 from processing.
    104 
    105 == report @ 9pm ==
    106 
    107 we've managed to get through 110 chips in the last 3 hours, compared
    108 with about 100 in the first 3 hours and 72 in the second three hours,
    109 so the rate is a bit faster now due to the larger number of machines.
    110 but, compared with the previous setup (1x1, 2x2, 3x3, 3xC) vs (1x1 3x2
    111 4x3 4xC), we have 15 + 15 + 17 = 32 more CPUs out of a previous total
    112 of 137 CPUs, or 25% more CPUs.  I don't think the processing is going
    113 25% faster that the first 3 hours (before the ipp039 bottleneck became
    114 a problem), but it is a little hard to judge.  If not, then it is
    115 evidence that we have still some I/O bottlenecks.  I'll look more
    116 closely at the times reported by the warp, diff, magic, and rc stages
    117 
    118 == report @ 9 am ==
    119 
    120 processing effectively stopped around 6am this morning, though the
    121 full analysis was not complete:
    122 
    123  * there are a number of chipRuns that have not finished: 37 exposures
    124  are still pending.  This is basically because of point 2:
    125 
    126  * ipp014 is unhappy: it is not so unhappy that it has been kicked out
    127  of nebulous, but files on it are giving I/O errors.  The failing chips
    128  are being caused by this, but coupled to a lingering nebulous error:
    129  the rules are forcing nebulous to return the ipp014 instance rather
    130  than randomize among the instances.  i'm going to reboot ipp014 and
    131  kick it out of nebulous for now.
    132 
    133 I'm attaching a snapshot of the ganglia load for the past 24 hours.
    134 you can see where the test started a bit before noon yesterday with
    135 the initial set of machines, and then the point where I crashed
    136 pantasks and restarted with and additional set of wave 2, 3, and C
    137 machines.  you can also see the problem machines caused by the
    138 nebulous distribution (ipp039 and a couple of the ipp04X machines),
    139 and the ones that have been giving occasional nfs issues (eg ipp016).
    140 I'm not certain if the latter issues are being cause by glitches in
    141 those raids, something equivalent to the causes of the ipp005 crashes,
    142 or because of poor data distribution.  this is something we need to
    143 investigate.
    144 
    145 [[Image(ganglia-throughput-20091104.png)]]
    146 
    147 === update ===
    148 
    149 I've gone through most errors and found the following:
    150 
    151  * all of the chip failures were caused by the issue with ipp014 ->
    152  these would be addessed by fixing the nebulous randomization.
    153  * all but one of the warp failures were caused by the chmod problem ->
    154  these can be addressed with one of the options I listed
    155  * the remaining warp failure was a more traditional NFS I/O problem,
    156  and would be naturally cleaned up with the revert pass
    157  * the diff failures I checked seemed to be the traditional NFS I/O
    158  problems, but we do not seem to have a diff revert task -- that is
    159  surprising!
    160 
    161 there are also some destreak failures which I did not investigate.
    162 also, destreak advance was getting timeouts, which says either the
    163 query needs to be adjust or the timeout period in pantasks does.
    164 finally, dist_component.pl had some failures, which are probably NFS
    165 I/O issues as well.
    1663
    1674== throughput summary ==
     
    19835^*^ roughly : ipp005 and ipp039 came in and out of the list at
    19936different times.
     37
     38== start @ 11:30am ==
     39
     40Bill, Heather & I have been running small-scale tests of the full
     41processing -> distribution to ensure all of the steps are working.
     42We've ironed out a few bugs and have a solid demonstration of the full
     43sequence including automatic diffs, magic, destreak, and distribution.
     44
     45I've just (at 11:35) launched a full-scale throughput demonstration
     46using 611 exposures.  These are 3pi exposures from July for the RA,DEC
     47range 270.0 - 300.0, 0.0 - 20.0.  There are g,r,i exposures,
     48supposedly all taken as TTI pairs.  Obviously, the fact that 611 is
     49odd, and 612 is the closest multiple of 6, says that at least one is
     50missing.
     51
     52I've also modified pantasks.pro (in ~ipp, not yet checked in) to fix
     53the problem where we get paths of the form /data/any.0/foo/bar
     54(something of a hack, I attempt to replace @HOST@.0 and @HOST@.1
     55before doing just @HOST@).  This should help with nfs load during
     56camera.
     57
     58=== update 1 ===
     59
     60my fix to the camera paths had no effect: the paths are now of the form:
     61
     62{{{neb://any/gpc1/throughput.20091104/o4999g0217o.78668/o4999g0217o.78668.cm.29757.smf}}}
     63
     64but they are still all going to ipp039, who is getting quite a load.
     65I'm going to remove it as a processing node so it can deal with the
     66camera I/O.
     67
     68=== update 2 ===
     69
     70we are having some trouble in this test because ipp039 is getting
     71really slammed.
     72
     73the situation is that the 'any' neb host problem is affecting more
     74than just camera: a number of every diff and warp run are also going
     75to 'any', which means ipp039.  I'm checking into the cause, but it
     76shows we need to fix this nebulous bug.
     77
     78=== update 3 ===
     79
     80i found a bug in the skycell by host pantasks function that allowed
     81the range to be larger than count, which in turn set a number of the
     82target hosts and nebulous volumes to 'any'.  i've fixed this, so
     83hopefully the load on ipp039 will fall again...
     84
     85== report @ 3pm ==
     86
     87looks like the fix I put in for this is now working: we have no
     88skycells with path_base including 'any' since the fix, and the load on
     89ipp039 has been mostly sensible since then as well.  there are
     90probably still a few warps sitting there that are being used for
     91diffs, so it will be elevated until those are done.
     92
     93the processing speed is looking mostly reasonable, except for the
     94diff_skycells, which were heavily hit by the ipp039 collisions.  I'll
     95be looking for those times to drop somewhat as well.
     96
     97So far, we are 3 hours into the test, and we have only processed 1/6
     98of the chips (and somewhat less of the other stages).  Since the goal
     99is 12 hours, we are running a bit behind.  I'm hopeful that the ipp039
     100collisions account for most of the gap...
     101
     102== report @ 6pm ==
     103
     104It has been 6 hours now, and the chip and diff processing times are
     105not much better than before.  We've only done about 30% of the data
     106set, so it is still going slowly.  At this rate, it will be 20 hours
     107before we finish this batch, which is kind of slow.  I'm going to
     108change my plan and try to boost the number of hosts.
     109
     110At the moment, our limiting steps have used the following number of seconds:
     111
     112{{{
     113chip: 1,021,709.35 sec
     114warp: 610,303.59 sec
     115diff: 540,536.4 sec
     116destreak: 259,726 sec
     117dist process: 177,430.2 sec
     118camera: 69,067.08 sec
     119}}}
     120
     121=== update 1 ===
     122
     123oops.
     124
     125I just attempted to load another set of wave 2 nodes and got a
     126segfault from pantasks...
     127
     128I'm going to wait 5 min for jobs to complete, and then I'll restart pantasks...
     129
     130=== update 2 ===
     131
     132OK, I've restarted the stdscience pantasks, and I've bumped up the
     133number of hosts to:
     134
     1351x1 3x2 4x3 4xC
     136
     137continuing to exclude ipp005 and ipp039 from processing.
     138
     139== report @ 9pm ==
     140
     141we've managed to get through 110 chips in the last 3 hours, compared
     142with about 100 in the first 3 hours and 72 in the second three hours,
     143so the rate is a bit faster now due to the larger number of machines.
     144but, compared with the previous setup (1x1, 2x2, 3x3, 3xC) vs (1x1 3x2
     1454x3 4xC), we have 15 + 15 + 17 = 32 more CPUs out of a previous total
     146of 137 CPUs, or 25% more CPUs.  I don't think the processing is going
     14725% faster that the first 3 hours (before the ipp039 bottleneck became
     148a problem), but it is a little hard to judge.  If not, then it is
     149evidence that we have still some I/O bottlenecks.  I'll look more
     150closely at the times reported by the warp, diff, magic, and rc stages
     151
     152== report @ 9 am ==
     153
     154processing effectively stopped around 6am this morning, though the
     155full analysis was not complete:
     156
     157 * there are a number of chipRuns that have not finished: 37 exposures
     158 are still pending.  This is basically because of point 2:
     159
     160 * ipp014 is unhappy: it is not so unhappy that it has been kicked out
     161 of nebulous, but files on it are giving I/O errors.  The failing chips
     162 are being caused by this, but coupled to a lingering nebulous error:
     163 the rules are forcing nebulous to return the ipp014 instance rather
     164 than randomize among the instances.  i'm going to reboot ipp014 and
     165 kick it out of nebulous for now.
     166
     167I'm attaching a snapshot of the ganglia load for the past 24 hours.
     168you can see where the test started a bit before noon yesterday with
     169the initial set of machines, and then the point where I crashed
     170pantasks and restarted with and additional set of wave 2, 3, and C
     171machines.  you can also see the problem machines caused by the
     172nebulous distribution (ipp039 and a couple of the ipp04X machines),
     173and the ones that have been giving occasional nfs issues (eg ipp016).
     174I'm not certain if the latter issues are being cause by glitches in
     175those raids, something equivalent to the causes of the ipp005 crashes,
     176or because of poor data distribution.  this is something we need to
     177investigate.
     178
     179[[Image(ganglia-throughput-20091104.png)]]
     180
     181=== update ===
     182
     183I've gone through most errors and found the following:
     184
     185 * all of the chip failures were caused by the issue with ipp014 ->
     186 these would be addessed by fixing the nebulous randomization.
     187 * all but one of the warp failures were caused by the chmod problem ->
     188 these can be addressed with one of the options I listed
     189 * the remaining warp failure was a more traditional NFS I/O problem,
     190 and would be naturally cleaned up with the revert pass
     191 * the diff failures I checked seemed to be the traditional NFS I/O
     192 problems, but we do not seem to have a diff revert task -- that is
     193 surprising!
     194
     195there are also some destreak failures which I did not investigate.
     196also, destreak advance was getting timeouts, which says either the
     197query needs to be adjust or the timeout period in pantasks does.
     198finally, dist_component.pl had some failures, which are probably NFS
     199I/O issues as well.
     200
     201== update at 11:35 ==
     202
     203this experiment is winding down slowly.  There are a few stragglers
     204that have required a little extra intervention to succeed (things like
     205removing files with bad permissions -- see the earlier nfs error), and
     206there are a few entries that stuck by a bug (3 in warp, 3 in diff so
     207far).  I'm turning off the warp revert task since the only outstanding
     208jobs are ones that require a bug fix.
     209
     210Of the 611 initial exposures, we have gotten all 611 through chip,
     211camera, and fake.  608 made it through warp.  608 warps only yielded
     212294 diffs (10 exposures must not have a corresponding TTI match), of
     213which 291 succeeded.  I expect to see 582 magicked exposures, but so
     214far we have only identified 578 exposures for magic -- there may be
     215some errors that need to be cleared in magic (no magic revert?).
     216