612 | | omni.py createslice IG-ST-3 |
613 | | stitcher.py createsliver IG-ST-3 IG-ST-3.rspec -o --excludehop urn:publicid:IDN+instageni.rutgers.edu+interface+procurve2:1.19.ion |
| 612 | $ stitcher.py createsliver IG-ST-3 IG-ST-3.rspec -o --excludehop urn:publicid:IDN+instageni.rutgers.edu+interface+procurve2:1.19.ion |
| 613 | 16:03:48 INFO : Configured logging from file /home/lnevers/gcf-2.7/src/gcf/stitcher_logging.conf |
| 614 | 16:03:49 INFO : Reading slice IG-ST-3 credential... |
| 615 | 16:03:49 INFO : Slice urn:publicid:IDN+ch.geni.net:ln-test+slice+IG-ST-3 expires on 2014-12-08 21:03:43 UTC |
| 616 | 16:03:49 INFO : Using SCS at http://nutshell.maxgigapop.net:8081/geni/xmlrpc |
| 617 | 16:03:49 INFO : Calling SCS... |
| 618 | 16:03:54 INFO : Multi-AM reservation will include resources from these aggregates: |
| 619 | 16:03:54 INFO : <Aggregate oess> |
| 620 | 16:03:54 INFO : <Aggregate utah-ig> |
| 621 | 16:03:54 INFO : <Aggregate gpo-ig> |
| 622 | 16:03:54 INFO : <Aggregate ion> |
| 623 | 16:03:54 INFO : <Aggregate rutgers-ig> |
| 624 | 16:03:54 INFO : <Aggregate utah-pg> |
| 625 | 16:03:54 INFO : Stitcher doing createsliver at <Aggregate gpo-ig>... |
| 626 | 16:04:11 INFO : ... Allocation at <Aggregate gpo-ig> complete. |
| 627 | 16:04:11 INFO : Stitcher doing createsliver at <Aggregate rutgers-ig>... |
| 628 | 16:04:30 INFO : ... Allocation at <Aggregate rutgers-ig> complete. |
| 629 | 16:04:30 INFO : Stitcher doing createsliver at <Aggregate utah-pg>... |
| 630 | 16:05:26 INFO : ... Allocation at <Aggregate utah-pg> complete. |
| 631 | 16:05:26 INFO : Stitcher doing createsliver at <Aggregate oess>... |
| 632 | 16:05:31 ERROR : {'output': 'Exception: requested VLAN unavailable: sdn-sw.newy32aoa.net.internet2.edu,e15/6 VLAN=3744', 'code': {'geni_code': 24}} |
| 633 | 16:05:31 WARNING : Stitching failed but will retry: Circuit reservation failed at <Aggregate oess>. Try again from the SCS. (Error: Topology too complex for local redo - ask Stitching Service to find a VLAN tag (AMAPIError: Error from Aggregate: code 24: Exception: requested VLAN unavailable: sdn-sw.newy32aoa.net.internet2.edu,e15/6 VLAN=3744.)) |
| 634 | 16:05:31 INFO : Deleting existing reservations... |
| 635 | 16:05:31 INFO : Doing deletesliver at <Aggregate gpo-ig>... |
| 636 | 16:05:54 INFO : Deleted reservation at <Aggregate gpo-ig>. |
| 637 | 16:05:54 INFO : Doing deletesliver at <Aggregate rutgers-ig>... |
| 638 | 16:05:57 INFO : Deleted reservation at <Aggregate rutgers-ig>. |
| 639 | 16:05:57 INFO : Doing deletesliver at <Aggregate utah-pg>... |
| 640 | 16:06:30 INFO : Deleted reservation at <Aggregate utah-pg>. |
| 641 | 16:06:30 INFO : Calling SCS for the 2nd time... |
| 642 | 16:06:33 INFO : Pausing for 30 seconds for Aggregates to free up resources... |
| 643 | |
| 644 | |
| 645 | 16:07:03 INFO : Multi-AM reservation will include resources from these aggregates: |
| 646 | 16:07:03 INFO : <Aggregate oess> |
| 647 | 16:07:03 INFO : <Aggregate utah-ig> |
| 648 | 16:07:03 INFO : <Aggregate gpo-ig> |
| 649 | 16:07:03 INFO : <Aggregate ion> |
| 650 | 16:07:03 INFO : <Aggregate rutgers-ig> |
| 651 | 16:07:03 INFO : <Aggregate utah-pg> |
| 652 | 16:07:03 INFO : Stitcher doing createsliver at <Aggregate gpo-ig>... |
| 653 | 16:07:19 INFO : ... Allocation at <Aggregate gpo-ig> complete. |
| 654 | 16:07:19 INFO : Stitcher doing createsliver at <Aggregate rutgers-ig>... |
| 655 | 16:07:36 INFO : ... Allocation at <Aggregate rutgers-ig> complete. |
| 656 | 16:07:36 INFO : Stitcher doing createsliver at <Aggregate utah-pg>... |
| 657 | 16:08:34 INFO : ... Allocation at <Aggregate utah-pg> complete. |
| 658 | 16:08:34 INFO : Stitcher doing createsliver at <Aggregate oess>... |
| 659 | 16:08:40 INFO : ... Allocation at <Aggregate oess> complete. |
| 660 | 16:08:40 INFO : Stitcher doing createsliver at <Aggregate utah-ig>... |
| 661 | 16:08:57 INFO : ... Allocation at <Aggregate utah-ig> complete. |
| 662 | 16:08:57 INFO : Stitcher doing createsliver at <Aggregate ion>... |
| 663 | 16:09:43 INFO : DCN AM <Aggregate ion>: must wait for status ready.... |
| 664 | 16:09:43 INFO : Pausing 30 seconds to let circuit become ready... |
| 665 | 16:10:20 INFO : Pausing 30 seconds to let circuit become ready... |
| 666 | 16:10:58 INFO : DCN circuit 141581 is ready at <Aggregate ion> |
| 667 | 16:10:58 INFO : DCN circuit 141591 is ready at <Aggregate ion> |
| 668 | 16:11:05 INFO : ... Allocation at <Aggregate ion> complete. |
| 669 | 16:11:05 INFO : All aggregates are complete. |
| 670 | 16:11:05 INFO : Your resources expire at 2014-12-06T20:57:03 (UTC). |
| 671 | 16:11:05 INFO : Saved combined reservation RSpec at 6 AMs to file '/home/lnevers/gcf-test/stitch-test/Rutgers/IG-ST-3-manifest-rspec-multiam-combined.xml' |
| 672 | Success: Reserved resources in slice IG-ST-3 at 6 Aggregates (including 3 intermediate aggregate(s) not in the original request), creating 2 stitched link(s). |