builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-036 starttime: 1448309878.65 results: success (0) buildid: 20151121014332 builduid: 366d0f62097c4c84bad0a3f63b5705d4 revision: 489332006384610e3322739f66729448da0e98d9 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.651675) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.652146) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.652443) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006400 basedir: '/builds/slave/test' ========= master_lag: 0.01 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.673068) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.673371) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.686709) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.687150) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004612 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.737814) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.738242) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.738815) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.739215) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-23 12:17:58-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.7M=0s 2015-11-23 12:17:58 (46.7 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.107559 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.860035) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.860435) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.022013 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.911578) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:58.911929) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 489332006384610e3322739f66729448da0e98d9 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 489332006384610e3322739f66729448da0e98d9 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-23 12:17:58,990 truncating revision to first 12 chars 2015-11-23 12:17:58,991 Setting DEBUG logging. 2015-11-23 12:17:58,991 attempt 1/10 2015-11-23 12:17:58,991 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/489332006384?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-23 12:17:59,215 unpacking tar archive at: fx-team-489332006384/testing/mozharness/ program finished with exit code 0 elapsedTime=0.500375 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:59.425204) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:59.425546) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:59.436280) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:59.436726) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-23 12:17:59.437198) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2015-11-23 12:17:59.437479) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:17:59 INFO - MultiFileLogger online at 20151123 12:17:59 in /builds/slave/test 12:17:59 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 12:17:59 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:17:59 INFO - {'append_to_log': False, 12:17:59 INFO - 'base_work_dir': '/builds/slave/test', 12:17:59 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 12:17:59 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:17:59 INFO - 'branch': 'Fx-Team-Non-PGO', 12:17:59 INFO - 'buildbot_json_path': 'buildprops.json', 12:17:59 INFO - 'config_files': ('talos/linux_config.py',), 12:17:59 INFO - 'default_actions': ('clobber', 12:17:59 INFO - 'read-buildbot-config', 12:17:59 INFO - 'download-and-extract', 12:17:59 INFO - 'populate-webroot', 12:17:59 INFO - 'create-virtualenv', 12:17:59 INFO - 'install', 12:17:59 INFO - 'run-tests'), 12:17:59 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:17:59 INFO - 'download_minidump_stackwalk': True, 12:17:59 INFO - 'download_symbols': 'ondemand', 12:17:59 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:17:59 INFO - 'tooltool.py': '/tools/tooltool.py', 12:17:59 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:17:59 INFO - '/tools/misc-python/virtualenv.py')}, 12:17:59 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:17:59 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:17:59 INFO - 'installer_path': 'installer.exe', 12:17:59 INFO - 'log_level': 'info', 12:17:59 INFO - 'log_name': 'talos', 12:17:59 INFO - 'log_to_console': True, 12:17:59 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:17:59 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:17:59 INFO - 'opt_config_files': (), 12:17:59 INFO - 'pip_index': False, 12:17:59 INFO - 'sps_profile': False, 12:17:59 INFO - 'sps_profile_interval': 0, 12:17:59 INFO - 'suite': 'dromaeojs-e10s', 12:17:59 INFO - 'system_bits': '64', 12:17:59 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:17:59 INFO - 'title': 'talos-linux64-ix-036', 12:17:59 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:17:59 INFO - 'use_talos_json': True, 12:17:59 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:17:59 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:17:59 INFO - 'work_dir': 'build'} 12:17:59 INFO - ##### 12:17:59 INFO - ##### Running clobber step. 12:17:59 INFO - ##### 12:17:59 INFO - Running pre-action listener: _resource_record_pre_action 12:17:59 INFO - Running main action method: clobber 12:17:59 INFO - rmtree: /builds/slave/test/build 12:17:59 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:18:00 INFO - Running post-action listener: _resource_record_post_action 12:18:00 INFO - ##### 12:18:00 INFO - ##### Running read-buildbot-config step. 12:18:00 INFO - ##### 12:18:00 INFO - Running pre-action listener: _resource_record_pre_action 12:18:00 INFO - Running main action method: read_buildbot_config 12:18:00 INFO - Using buildbot properties: 12:18:00 INFO - { 12:18:00 INFO - "properties": { 12:18:00 INFO - "buildnumber": 713, 12:18:00 INFO - "product": "firefox", 12:18:00 INFO - "script_repo_revision": "production", 12:18:00 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 12:18:00 INFO - "repository": "", 12:18:00 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 12:18:00 INFO - "buildid": "20151121014332", 12:18:00 INFO - "slavename": "talos-linux64-ix-036", 12:18:00 INFO - "pgo_build": "False", 12:18:00 INFO - "basedir": "/builds/slave/test", 12:18:00 INFO - "project": "", 12:18:00 INFO - "platform": "ubuntu64_hw", 12:18:00 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 12:18:00 INFO - "slavebuilddir": "test", 12:18:00 INFO - "scheduler": "tests-fx-team-linux64-talos", 12:18:00 INFO - "branch": "fx-team", 12:18:00 INFO - "repo_path": "integration/fx-team", 12:18:00 INFO - "stage_platform": "linux64", 12:18:00 INFO - "builduid": "366d0f62097c4c84bad0a3f63b5705d4", 12:18:00 INFO - "revision": "489332006384610e3322739f66729448da0e98d9" 12:18:00 INFO - }, 12:18:00 INFO - "sourcestamp": { 12:18:00 INFO - "repository": "", 12:18:00 INFO - "hasPatch": false, 12:18:00 INFO - "project": "", 12:18:00 INFO - "branch": "fx-team-linux64-talos", 12:18:00 INFO - "changes": [ 12:18:00 INFO - { 12:18:00 INFO - "category": null, 12:18:00 INFO - "files": [ 12:18:00 INFO - { 12:18:00 INFO - "url": null, 12:18:00 INFO - "name": "https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 12:18:00 INFO - } 12:18:00 INFO - ], 12:18:00 INFO - "repository": "", 12:18:00 INFO - "rev": "489332006384610e3322739f66729448da0e98d9", 12:18:00 INFO - "who": "dgottwald@mozilla.com", 12:18:00 INFO - "when": 1448100613, 12:18:00 INFO - "number": 6692170, 12:18:00 INFO - "comments": "Bug 644529 - Remove gap between bookmarks toolbar menu buttons and their popups. r=gijs", 12:18:00 INFO - "project": "", 12:18:00 INFO - "at": "Sat 21 Nov 2015 02:10:13", 12:18:00 INFO - "branch": "fx-team-linux64-talos", 12:18:00 INFO - "revlink": "", 12:18:00 INFO - "properties": [ 12:18:00 INFO - [ 12:18:00 INFO - "buildid", 12:18:00 INFO - "20151121014332", 12:18:00 INFO - "Change" 12:18:00 INFO - ], 12:18:00 INFO - [ 12:18:00 INFO - "builduid", 12:18:00 INFO - "366d0f62097c4c84bad0a3f63b5705d4", 12:18:00 INFO - "Change" 12:18:00 INFO - ], 12:18:00 INFO - [ 12:18:00 INFO - "pgo_build", 12:18:00 INFO - "False", 12:18:00 INFO - "Change" 12:18:00 INFO - ] 12:18:00 INFO - ], 12:18:00 INFO - "revision": "489332006384610e3322739f66729448da0e98d9" 12:18:00 INFO - } 12:18:00 INFO - ], 12:18:00 INFO - "revision": "489332006384610e3322739f66729448da0e98d9" 12:18:00 INFO - } 12:18:00 INFO - } 12:18:00 INFO - Found installer url https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 12:18:00 INFO - Running post-action listener: _resource_record_post_action 12:18:00 INFO - ##### 12:18:00 INFO - ##### Running download-and-extract step. 12:18:00 INFO - ##### 12:18:00 INFO - Running pre-action listener: _resource_record_pre_action 12:18:00 INFO - Running main action method: download_and_extract 12:18:00 INFO - mkdir: /builds/slave/test/build/tests 12:18:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:00 INFO - https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 12:18:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/test_packages.json 12:18:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/test_packages.json 12:18:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 12:18:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 12:18:01 INFO - Downloaded 1302 bytes. 12:18:01 INFO - Reading from file /builds/slave/test/build/test_packages.json 12:18:01 INFO - Using the following test package requirements: 12:18:01 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 12:18:01 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 12:18:01 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:18:01 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 12:18:01 INFO - u'jsshell-linux-x86_64.zip'], 12:18:01 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 12:18:01 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:18:01 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 12:18:01 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 12:18:01 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:18:01 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 12:18:01 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:18:01 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 12:18:01 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:18:01 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 12:18:01 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 12:18:01 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:18:01 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:18:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:01 INFO - https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:18:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:18:02 INFO - Downloaded 21339409 bytes. 12:18:02 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 12:18:02 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:02 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 12:18:03 INFO - Return code: 0 12:18:03 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 12:18:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:03 INFO - https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:18:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 12:18:04 INFO - Downloaded 21339409 bytes. 12:18:04 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 12:18:04 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 12:18:04 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 12:18:05 INFO - Return code: 0 12:18:05 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:05 INFO - https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 12:18:05 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 12:18:05 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 12:18:05 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 12:18:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 12:18:06 INFO - Downloaded 11130997 bytes. 12:18:06 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 12:18:06 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 12:18:07 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 12:18:07 INFO - Return code: 0 12:18:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:07 INFO - https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 12:18:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 12:18:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 12:18:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 12:18:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 12:18:09 INFO - Downloaded 55909927 bytes. 12:18:09 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 12:18:09 INFO - mkdir: /builds/slave/test/properties 12:18:09 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:18:09 INFO - Writing to file /builds/slave/test/properties/build_url 12:18:09 INFO - Contents: 12:18:09 INFO - build_url:https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 12:18:09 INFO - Running post-action listener: _resource_record_post_action 12:18:09 INFO - Running post-action listener: set_extra_try_arguments 12:18:09 INFO - ##### 12:18:09 INFO - ##### Running populate-webroot step. 12:18:09 INFO - ##### 12:18:09 INFO - Running pre-action listener: _resource_record_pre_action 12:18:09 INFO - Running main action method: populate_webroot 12:18:09 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:18:09 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:18:09 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 12:18:09 INFO - '../fennec_ids.txt'], 12:18:09 INFO - 'tests': ['tcheck2']}, 12:18:09 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:18:09 INFO - '--tppagecycles', 12:18:09 INFO - '7'], 12:18:09 INFO - 'tests': ['tsvgm']}}, 12:18:09 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 12:18:09 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:18:09 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 12:18:09 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 12:18:09 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:18:09 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:18:09 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'tests': ['damp', 'tps']}, 12:18:09 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['damp', 'tps']}, 12:18:09 INFO - 'g3': {'tests': ['dromaeo_dom']}, 12:18:09 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:18:09 INFO - 'other': {'tests': ['a11yr', 12:18:09 INFO - 'ts_paint', 12:18:09 INFO - 'tpaint', 12:18:09 INFO - 'sessionrestore', 12:18:09 INFO - 'sessionrestore_no_auto_restore']}, 12:18:09 INFO - 'other-e10s': {'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['a11yr', 12:18:09 INFO - 'ts_paint', 12:18:09 INFO - 'tpaint', 12:18:09 INFO - 'sessionrestore', 12:18:09 INFO - 'sessionrestore_no_auto_restore']}, 12:18:09 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['a11yr', 12:18:09 INFO - 'ts_paint', 12:18:09 INFO - 'tpaint', 12:18:09 INFO - 'sessionrestore', 12:18:09 INFO - 'sessionrestore_no_auto_restore']}, 12:18:09 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['a11yr', 12:18:09 INFO - 'ts_paint', 12:18:09 INFO - 'tpaint', 12:18:09 INFO - 'sessionrestore', 12:18:09 INFO - 'sessionrestore_no_auto_restore']}, 12:18:09 INFO - 'other_l64': {'tests': ['a11yr', 12:18:09 INFO - 'ts_paint', 12:18:09 INFO - 'tpaint', 12:18:09 INFO - 'sessionrestore', 12:18:09 INFO - 'sessionrestore_no_auto_restore']}, 12:18:09 INFO - 'other_nol64': {'tests': ['a11yr', 12:18:09 INFO - 'ts_paint', 12:18:09 INFO - 'tpaint', 12:18:09 INFO - 'sessionrestore', 12:18:09 INFO - 'sessionrestore_no_auto_restore']}, 12:18:09 INFO - 'svgr': {'tests': ['tsvgx', 12:18:09 INFO - 'tsvgr_opacity', 12:18:09 INFO - 'tart', 12:18:09 INFO - 'tscrollx', 12:18:09 INFO - 'cart']}, 12:18:09 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['tsvgx', 12:18:09 INFO - 'tsvgr_opacity', 12:18:09 INFO - 'tart', 12:18:09 INFO - 'tscrollx', 12:18:09 INFO - 'cart']}, 12:18:09 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'tests': ['tp5o']}, 12:18:09 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'talos_options': ['--e10s'], 12:18:09 INFO - 'tests': ['tp5o']}, 12:18:09 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'talos_options': ['--xperf_path', 12:18:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:18:09 INFO - 'tests': ['tp5n']}, 12:18:09 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:18:09 INFO - 'talos_options': ['--e10s', 12:18:09 INFO - '--xperf_path', 12:18:09 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:18:09 INFO - 'tests': ['tp5n']}}, 12:18:09 INFO - 'talos.zip': {'path': '', 12:18:09 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:18:09 INFO - Running post-action listener: _resource_record_post_action 12:18:09 INFO - ##### 12:18:09 INFO - ##### Running create-virtualenv step. 12:18:09 INFO - ##### 12:18:09 INFO - Running pre-action listener: _resource_record_pre_action 12:18:09 INFO - Running main action method: create_virtualenv 12:18:09 INFO - Creating virtualenv /builds/slave/test/build/venv 12:18:09 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 12:18:09 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:18:09 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:18:09 INFO - Using real prefix '/usr' 12:18:09 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:18:09 INFO - Installing distribute.............................................................................................................................................................................................done. 12:18:11 INFO - Installing pip.................done. 12:18:11 INFO - Return code: 0 12:18:11 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:18:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:18:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:18:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f0483e62c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19666c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a17900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:18:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 12:18:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 12:18:11 INFO - Using env: {'DISPLAY': ':0', 12:18:11 INFO - 'HOME': '/home/cltbld', 12:18:11 INFO - 'LANG': 'en_US.UTF-8', 12:18:11 INFO - 'LANGUAGE': 'en_US:en', 12:18:11 INFO - 'LOGNAME': 'cltbld', 12:18:11 INFO - 'MAIL': '/var/mail/cltbld', 12:18:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:11 INFO - 'MOZ_NO_REMOTE': '1', 12:18:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:11 INFO - 'NO_EM_RESTART': '1', 12:18:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:11 INFO - 'PWD': '/builds/slave/test', 12:18:11 INFO - 'SHELL': '/bin/bash', 12:18:11 INFO - 'SHLVL': '1', 12:18:11 INFO - 'TERM': 'linux', 12:18:11 INFO - 'TMOUT': '86400', 12:18:11 INFO - 'USER': 'cltbld', 12:18:11 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:11 INFO - '_': '/tools/buildbot/bin/python'} 12:18:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:18:12 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 12:18:12 INFO - Cleaning up... 12:18:12 INFO - Return code: 0 12:18:12 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 12:18:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:18:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:18:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f0483e62c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19666c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a17900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:18:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 12:18:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 12:18:12 INFO - Using env: {'DISPLAY': ':0', 12:18:12 INFO - 'HOME': '/home/cltbld', 12:18:12 INFO - 'LANG': 'en_US.UTF-8', 12:18:12 INFO - 'LANGUAGE': 'en_US:en', 12:18:12 INFO - 'LOGNAME': 'cltbld', 12:18:12 INFO - 'MAIL': '/var/mail/cltbld', 12:18:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:12 INFO - 'MOZ_NO_REMOTE': '1', 12:18:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:12 INFO - 'NO_EM_RESTART': '1', 12:18:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:12 INFO - 'PWD': '/builds/slave/test', 12:18:12 INFO - 'SHELL': '/bin/bash', 12:18:12 INFO - 'SHLVL': '1', 12:18:12 INFO - 'TERM': 'linux', 12:18:12 INFO - 'TMOUT': '86400', 12:18:12 INFO - 'USER': 'cltbld', 12:18:12 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:12 INFO - '_': '/tools/buildbot/bin/python'} 12:18:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:18:12 INFO - Downloading/unpacking psutil>=0.7.1 12:18:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:13 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 12:18:13 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 12:18:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:18:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:18:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:18:14 INFO - Installing collected packages: psutil 12:18:14 INFO - Running setup.py install for psutil 12:18:14 INFO - building 'psutil._psutil_linux' extension 12:18:14 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 12:18:14 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 12:18:14 INFO - building 'psutil._psutil_posix' extension 12:18:14 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 12:18:14 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 12:18:14 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:18:14 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:18:14 INFO - Successfully installed psutil 12:18:14 INFO - Cleaning up... 12:18:14 INFO - Return code: 0 12:18:14 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 12:18:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:18:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:18:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f0483e62c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19666c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a17900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:18:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 12:18:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 12:18:14 INFO - Using env: {'DISPLAY': ':0', 12:18:14 INFO - 'HOME': '/home/cltbld', 12:18:14 INFO - 'LANG': 'en_US.UTF-8', 12:18:14 INFO - 'LANGUAGE': 'en_US:en', 12:18:14 INFO - 'LOGNAME': 'cltbld', 12:18:14 INFO - 'MAIL': '/var/mail/cltbld', 12:18:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:14 INFO - 'MOZ_NO_REMOTE': '1', 12:18:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:14 INFO - 'NO_EM_RESTART': '1', 12:18:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:14 INFO - 'PWD': '/builds/slave/test', 12:18:14 INFO - 'SHELL': '/bin/bash', 12:18:14 INFO - 'SHLVL': '1', 12:18:14 INFO - 'TERM': 'linux', 12:18:14 INFO - 'TMOUT': '86400', 12:18:14 INFO - 'USER': 'cltbld', 12:18:14 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:14 INFO - '_': '/tools/buildbot/bin/python'} 12:18:14 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:18:14 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 12:18:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:16 INFO - Downloading mozsystemmonitor-0.0.tar.gz 12:18:16 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 12:18:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:18:16 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 12:18:16 INFO - Installing collected packages: mozsystemmonitor 12:18:16 INFO - Running setup.py install for mozsystemmonitor 12:18:16 INFO - Successfully installed mozsystemmonitor 12:18:16 INFO - Cleaning up... 12:18:16 INFO - Return code: 0 12:18:16 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:18:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:18:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:18:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:16 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f0483e62c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19666c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a17900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:18:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 12:18:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 12:18:16 INFO - Using env: {'DISPLAY': ':0', 12:18:16 INFO - 'HOME': '/home/cltbld', 12:18:16 INFO - 'LANG': 'en_US.UTF-8', 12:18:16 INFO - 'LANGUAGE': 'en_US:en', 12:18:16 INFO - 'LOGNAME': 'cltbld', 12:18:16 INFO - 'MAIL': '/var/mail/cltbld', 12:18:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:16 INFO - 'MOZ_NO_REMOTE': '1', 12:18:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:16 INFO - 'NO_EM_RESTART': '1', 12:18:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:16 INFO - 'PWD': '/builds/slave/test', 12:18:16 INFO - 'SHELL': '/bin/bash', 12:18:16 INFO - 'SHLVL': '1', 12:18:16 INFO - 'TERM': 'linux', 12:18:16 INFO - 'TMOUT': '86400', 12:18:16 INFO - 'USER': 'cltbld', 12:18:16 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:16 INFO - '_': '/tools/buildbot/bin/python'} 12:18:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:18:16 INFO - Downloading/unpacking blobuploader==1.2.4 12:18:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:16 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:16 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:16 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:16 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:18 INFO - Downloading blobuploader-1.2.4.tar.gz 12:18:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 12:18:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:18:18 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:18:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 12:18:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:18:19 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:18:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:19 INFO - Downloading docopt-0.6.1.tar.gz 12:18:19 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 12:18:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:18:19 INFO - Installing collected packages: blobuploader, requests, docopt 12:18:19 INFO - Running setup.py install for blobuploader 12:18:19 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:18:19 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:18:19 INFO - Running setup.py install for requests 12:18:19 INFO - Running setup.py install for docopt 12:18:19 INFO - Successfully installed blobuploader requests docopt 12:18:19 INFO - Cleaning up... 12:18:19 INFO - Return code: 0 12:18:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:18:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:18:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:18:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f0483e62c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19666c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a17900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:18:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:18:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:18:19 INFO - Using env: {'DISPLAY': ':0', 12:18:19 INFO - 'HOME': '/home/cltbld', 12:18:19 INFO - 'LANG': 'en_US.UTF-8', 12:18:19 INFO - 'LANGUAGE': 'en_US:en', 12:18:19 INFO - 'LOGNAME': 'cltbld', 12:18:19 INFO - 'MAIL': '/var/mail/cltbld', 12:18:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:19 INFO - 'MOZ_NO_REMOTE': '1', 12:18:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:19 INFO - 'NO_EM_RESTART': '1', 12:18:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:19 INFO - 'PWD': '/builds/slave/test', 12:18:19 INFO - 'SHELL': '/bin/bash', 12:18:19 INFO - 'SHLVL': '1', 12:18:19 INFO - 'TERM': 'linux', 12:18:19 INFO - 'TMOUT': '86400', 12:18:19 INFO - 'USER': 'cltbld', 12:18:19 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:19 INFO - '_': '/tools/buildbot/bin/python'} 12:18:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:18:20 INFO - Running setup.py (path:/tmp/pip-a2d9KR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:18:20 INFO - Running setup.py (path:/tmp/pip-kO675d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:18:20 INFO - Running setup.py (path:/tmp/pip-0ufobf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:18:20 INFO - Running setup.py (path:/tmp/pip-1nXo63-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:18:20 INFO - Running setup.py (path:/tmp/pip-kYn8pW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:18:20 INFO - Running setup.py (path:/tmp/pip-qsCQWz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:18:20 INFO - Running setup.py (path:/tmp/pip-nJmqMN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:18:20 INFO - Running setup.py (path:/tmp/pip-W7ODet-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:18:20 INFO - Running setup.py (path:/tmp/pip-NXHN4W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:18:20 INFO - Running setup.py (path:/tmp/pip-tioqT3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:18:20 INFO - Running setup.py (path:/tmp/pip-JFspMa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:18:20 INFO - Running setup.py (path:/tmp/pip-F_Z0hS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:18:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:18:20 INFO - Running setup.py (path:/tmp/pip-Fu3mdt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:18:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:18:21 INFO - Running setup.py (path:/tmp/pip-rf1z93-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:18:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:18:21 INFO - Running setup.py (path:/tmp/pip-A4vEIg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:18:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:18:21 INFO - Running setup.py (path:/tmp/pip-4ZMxP5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:18:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:18:21 INFO - Running setup.py (path:/tmp/pip-itKA4E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:18:21 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:18:21 INFO - Running setup.py install for manifestparser 12:18:21 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:18:21 INFO - Running setup.py install for mozcrash 12:18:21 INFO - Running setup.py install for mozdebug 12:18:21 INFO - Running setup.py install for mozdevice 12:18:21 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:18:21 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:18:21 INFO - Running setup.py install for mozfile 12:18:21 INFO - Running setup.py install for mozhttpd 12:18:21 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:18:21 INFO - Running setup.py install for mozinfo 12:18:22 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Running setup.py install for mozInstall 12:18:22 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Running setup.py install for mozleak 12:18:22 INFO - Running setup.py install for mozlog 12:18:22 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Running setup.py install for moznetwork 12:18:22 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Running setup.py install for mozprocess 12:18:22 INFO - Running setup.py install for mozprofile 12:18:22 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Running setup.py install for mozrunner 12:18:22 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:18:22 INFO - Running setup.py install for mozscreenshot 12:18:22 INFO - Running setup.py install for moztest 12:18:22 INFO - Running setup.py install for mozversion 12:18:23 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:18:23 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:18:23 INFO - Cleaning up... 12:18:23 INFO - Return code: 0 12:18:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:18:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:18:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:18:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:23 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f0483e62c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19666c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a17900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:18:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:18:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:18:23 INFO - Using env: {'DISPLAY': ':0', 12:18:23 INFO - 'HOME': '/home/cltbld', 12:18:23 INFO - 'LANG': 'en_US.UTF-8', 12:18:23 INFO - 'LANGUAGE': 'en_US:en', 12:18:23 INFO - 'LOGNAME': 'cltbld', 12:18:23 INFO - 'MAIL': '/var/mail/cltbld', 12:18:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:23 INFO - 'MOZ_NO_REMOTE': '1', 12:18:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:23 INFO - 'NO_EM_RESTART': '1', 12:18:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:23 INFO - 'PWD': '/builds/slave/test', 12:18:23 INFO - 'SHELL': '/bin/bash', 12:18:23 INFO - 'SHLVL': '1', 12:18:23 INFO - 'TERM': 'linux', 12:18:23 INFO - 'TMOUT': '86400', 12:18:23 INFO - 'USER': 'cltbld', 12:18:23 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:23 INFO - '_': '/tools/buildbot/bin/python'} 12:18:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:18:23 INFO - Running setup.py (path:/tmp/pip-ZyVG4L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:18:23 INFO - Running setup.py (path:/tmp/pip-Hi1GEy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:18:23 INFO - Running setup.py (path:/tmp/pip-l64g2X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:18:23 INFO - Running setup.py (path:/tmp/pip-LkcqSN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:18:23 INFO - Running setup.py (path:/tmp/pip-C8iKpK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:18:23 INFO - Running setup.py (path:/tmp/pip-M8vJry-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:18:23 INFO - Running setup.py (path:/tmp/pip-gN5L92-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:18:23 INFO - Running setup.py (path:/tmp/pip-5PIaYn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:18:23 INFO - Running setup.py (path:/tmp/pip-TPSztG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:18:23 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 12:18:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:18:23 INFO - Running setup.py (path:/tmp/pip-seXHtX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.0 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:18:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:18:24 INFO - Running setup.py (path:/tmp/pip-3i9tLf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 12:18:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:18:24 INFO - Running setup.py (path:/tmp/pip-2c2JcM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 12:18:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:18:24 INFO - Running setup.py (path:/tmp/pip-gkkBMi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 12:18:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:18:24 INFO - Running setup.py (path:/tmp/pip-pzpH3K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 12:18:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:18:24 INFO - Running setup.py (path:/tmp/pip-ius4Cu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 12:18:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:18:24 INFO - Running setup.py (path:/tmp/pip-mhqax2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 12:18:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:18:24 INFO - Running setup.py (path:/tmp/pip-GvbNPu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:18:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:18:24 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:18:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:24 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:24 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:18:24 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:18:24 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:18:26 INFO - Downloading blessings-1.5.1.tar.gz 12:18:26 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 12:18:26 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:18:26 INFO - Installing collected packages: blessings 12:18:26 INFO - Running setup.py install for blessings 12:18:26 INFO - Successfully installed blessings 12:18:26 INFO - Cleaning up... 12:18:26 INFO - Return code: 0 12:18:26 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:18:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:18:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:18:26 INFO - Reading from file tmpfile_stdout 12:18:26 INFO - Current package versions: 12:18:26 INFO - argparse == 1.2.1 12:18:26 INFO - blessings == 1.5.1 12:18:26 INFO - blobuploader == 1.2.4 12:18:26 INFO - docopt == 0.6.1 12:18:26 INFO - manifestparser == 1.1 12:18:26 INFO - mozInstall == 1.12 12:18:26 INFO - mozcrash == 0.16 12:18:26 INFO - mozdebug == 0.1 12:18:26 INFO - mozdevice == 0.47 12:18:26 INFO - mozfile == 1.2 12:18:26 INFO - mozhttpd == 0.7 12:18:26 INFO - mozinfo == 0.9 12:18:26 INFO - mozleak == 0.1 12:18:26 INFO - mozlog == 3.0 12:18:26 INFO - moznetwork == 0.27 12:18:26 INFO - mozprocess == 0.22 12:18:26 INFO - mozprofile == 0.27 12:18:26 INFO - mozrunner == 6.11 12:18:26 INFO - mozscreenshot == 0.1 12:18:26 INFO - mozsystemmonitor == 0.0 12:18:26 INFO - moztest == 0.7 12:18:26 INFO - mozversion == 1.4 12:18:26 INFO - psutil == 3.1.1 12:18:26 INFO - requests == 1.2.3 12:18:26 INFO - wsgiref == 0.1.2 12:18:26 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:18:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:26 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:18:26 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:26 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:26 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:18:26 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:18:26 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f0483e62c70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19666c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1a17900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:18:26 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 12:18:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:18:26 INFO - Using env: {'DISPLAY': ':0', 12:18:26 INFO - 'HOME': '/home/cltbld', 12:18:26 INFO - 'LANG': 'en_US.UTF-8', 12:18:26 INFO - 'LANGUAGE': 'en_US:en', 12:18:26 INFO - 'LOGNAME': 'cltbld', 12:18:26 INFO - 'MAIL': '/var/mail/cltbld', 12:18:26 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:26 INFO - 'MOZ_NO_REMOTE': '1', 12:18:26 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:26 INFO - 'NO_EM_RESTART': '1', 12:18:26 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:26 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:26 INFO - 'PWD': '/builds/slave/test', 12:18:26 INFO - 'SHELL': '/bin/bash', 12:18:26 INFO - 'SHLVL': '1', 12:18:26 INFO - 'TERM': 'linux', 12:18:26 INFO - 'TMOUT': '86400', 12:18:26 INFO - 'USER': 'cltbld', 12:18:26 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:26 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:26 INFO - '_': '/tools/buildbot/bin/python'} 12:18:26 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 12:18:26 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 12:18:26 INFO - Cleaning up... 12:18:26 INFO - Return code: 0 12:18:26 INFO - Running post-action listener: _resource_record_post_action 12:18:26 INFO - Running post-action listener: _start_resource_monitoring 12:18:26 INFO - Starting resource monitoring. 12:18:26 INFO - ##### 12:18:26 INFO - ##### Running install step. 12:18:26 INFO - ##### 12:18:26 INFO - Running pre-action listener: _resource_record_pre_action 12:18:26 INFO - Running main action method: install 12:18:26 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:18:26 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:18:27 INFO - Reading from file tmpfile_stdout 12:18:27 INFO - Detecting whether we're running mozinstall >=1.0... 12:18:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:18:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:18:27 INFO - Reading from file tmpfile_stdout 12:18:27 INFO - Output received: 12:18:27 INFO - Usage: mozinstall [options] installer 12:18:27 INFO - Options: 12:18:27 INFO - -h, --help show this help message and exit 12:18:27 INFO - -d DEST, --destination=DEST 12:18:27 INFO - Directory to install application into. [default: 12:18:27 INFO - "/builds/slave/test"] 12:18:27 INFO - --app=APP Application being installed. [default: firefox] 12:18:27 INFO - mkdir: /builds/slave/test/build/application 12:18:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:18:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:18:41 INFO - Reading from file tmpfile_stdout 12:18:41 INFO - Output received: 12:18:41 INFO - /builds/slave/test/build/application/firefox/firefox 12:18:41 INFO - Running post-action listener: _resource_record_post_action 12:18:41 INFO - ##### 12:18:41 INFO - ##### Running run-tests step. 12:18:41 INFO - ##### 12:18:41 INFO - Running pre-action listener: _resource_record_pre_action 12:18:41 INFO - Running main action method: run_tests 12:18:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:18:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:18:41 INFO - Python 2.7.3 12:18:41 INFO - Return code: 0 12:18:41 INFO - grabbing minidump binary from tooltool 12:18:41 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:18:41 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a5db70>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1aaedc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1aaf250>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:18:41 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 12:18:41 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 12:18:41 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:18:41 INFO - Return code: 0 12:18:41 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:18:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:18:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:18:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:18:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:18:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-036', '--webServer', 'localhost'] in /builds/slave/test/build 12:18:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-036 --webServer localhost 12:18:41 INFO - Using env: {'DISPLAY': ':0', 12:18:41 INFO - 'HOME': '/home/cltbld', 12:18:41 INFO - 'LANG': 'en_US.UTF-8', 12:18:41 INFO - 'LANGUAGE': 'en_US:en', 12:18:41 INFO - 'LOGNAME': 'cltbld', 12:18:41 INFO - 'MAIL': '/var/mail/cltbld', 12:18:41 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:18:41 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:18:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:18:41 INFO - 'MOZ_NO_REMOTE': '1', 12:18:41 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:18:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:18:41 INFO - 'NO_EM_RESTART': '1', 12:18:41 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:18:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:18:41 INFO - 'PWD': '/builds/slave/test', 12:18:41 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:18:41 INFO - 'SHELL': '/bin/bash', 12:18:41 INFO - 'SHLVL': '1', 12:18:41 INFO - 'TERM': 'linux', 12:18:41 INFO - 'TMOUT': '86400', 12:18:41 INFO - 'USER': 'cltbld', 12:18:41 INFO - 'XDG_SESSION_COOKIE': '9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311', 12:18:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:18:41 INFO - '_': '/tools/buildbot/bin/python'} 12:18:41 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-036', '--webServer', 'localhost'] with output_timeout 3600 12:18:41 INFO - mozversion INFO | application_buildid: 20151121014332 12:18:41 INFO - mozversion INFO | application_changeset: 489332006384610e3322739f66729448da0e98d9 12:18:41 INFO - mozversion INFO | application_display_name: Nightly 12:18:41 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:18:41 INFO - mozversion INFO | application_name: Firefox 12:18:41 INFO - mozversion INFO | application_remotingname: firefox 12:18:41 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 12:18:41 INFO - mozversion INFO | application_vendor: Mozilla 12:18:41 INFO - mozversion INFO | application_version: 45.0a1 12:18:41 INFO - mozversion INFO | platform_buildid: 20151121014332 12:18:41 INFO - mozversion INFO | platform_changeset: 489332006384610e3322739f66729448da0e98d9 12:18:41 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 12:18:41 INFO - mozversion INFO | platform_version: 45.0a1 12:18:41 INFO - 2015-11-23 12:18:41,577 DEBUG : using testdate: 1448309921 12:18:41 INFO - 2015-11-23 12:18:41,577 DEBUG : actual date: 1448309921 12:18:41 INFO - 2015-11-23 12:18:41,585 INFO : starting webserver on 'localhost:43424' 12:18:41 INFO - 2015-11-23 12:18:41,585 INFO : Starting test suite talos-linux64-ix-036.e 12:18:41 INFO - 2015-11-23 12:18:41,585 INFO : Starting test dromaeo_css 12:18:41 INFO - 2015-11-23 12:18:41,585 DEBUG : operating with platform_type : linux_ 12:18:41 INFO - 2015-11-23 12:18:41,586 INFO : Initialising browser for dromaeo_css test... 12:18:41 INFO - 2015-11-23 12:18:41,593 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiB8AP5/profile http://localhost:43424/getInfo.html 12:18:48 INFO - 2015-11-23 12:18:48,898 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 12:18:48 INFO - 2015-11-23 12:18:48,899 DEBUG : BROWSER_OUTPUT: colorDepth:24 12:18:48 INFO - 2015-11-23 12:18:48,899 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 12:18:48 INFO - 2015-11-23 12:18:48,899 DEBUG : BROWSER_OUTPUT: __metrics 12:18:50 INFO - 2015-11-23 12:18:50,057 INFO : Browser initialized. 12:18:50 INFO - 2015-11-23 12:18:50,058 INFO : Running cycle 1/1 for dromaeo_css test... 12:18:50 INFO - 2015-11-23 12:18:50,058 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiB8AP5/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 12:19:01 INFO - 2015-11-23 12:19:01,955 DEBUG : BROWSER_OUTPUT: RSS: Main: 141656064 12:19:01 INFO - 2015-11-23 12:19:01,956 DEBUG : BROWSER_OUTPUT: 12:19:51 INFO - 2015-11-23 12:19:51,608 DEBUG : BROWSER_OUTPUT: 1448309991607 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 12:22:03 INFO - 2015-11-23 12:22:03,830 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/dromaeo/cssquery-dojo.html (next: http://localhost:43424/tests/dromaeo/cssquery-ext.html) 12:22:05 INFO - 2015-11-23 12:22:05,008 DEBUG : BROWSER_OUTPUT: RSS: Main: 145567744 12:22:05 INFO - 2015-11-23 12:22:05,008 DEBUG : BROWSER_OUTPUT: 12:25:07 INFO - 2015-11-23 12:25:07,128 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/dromaeo/cssquery-ext.html (next: http://localhost:43424/tests/dromaeo/cssquery-jquery.html) 12:25:07 INFO - 2015-11-23 12:25:07,714 DEBUG : BROWSER_OUTPUT: RSS: Main: 143294464 12:25:07 INFO - 2015-11-23 12:25:07,714 DEBUG : BROWSER_OUTPUT: 12:28:09 INFO - 2015-11-23 12:28:09,542 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/dromaeo/cssquery-jquery.html (next: http://localhost:43424/tests/dromaeo/cssquery-mootools.html) 12:28:10 INFO - 2015-11-23 12:28:10,136 DEBUG : BROWSER_OUTPUT: RSS: Main: 143929344 12:28:10 INFO - 2015-11-23 12:28:10,136 DEBUG : BROWSER_OUTPUT: 12:31:11 INFO - 2015-11-23 12:31:11,887 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/dromaeo/cssquery-mootools.html (next: http://localhost:43424/tests/dromaeo/cssquery-prototype.html) 12:31:12 INFO - 2015-11-23 12:31:12,497 DEBUG : BROWSER_OUTPUT: RSS: Main: 140984320 12:31:12 INFO - 2015-11-23 12:31:12,497 DEBUG : BROWSER_OUTPUT: 12:34:15 INFO - 2015-11-23 12:34:15,167 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/dromaeo/cssquery-prototype.html (next: http://localhost:43424/tests/dromaeo/cssquery-yui.html) 12:34:15 INFO - 2015-11-23 12:34:15,768 DEBUG : BROWSER_OUTPUT: RSS: Main: 142082048 12:34:15 INFO - 2015-11-23 12:34:15,768 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,101 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/dromaeo/cssquery-yui.html (next: http://localhost:43424/tests/dromaeo/cssquery-dojo.html) 12:37:18 INFO - 2015-11-23 12:37:18,351 DEBUG : BROWSER_OUTPUT: RSS: Main: 143462400 12:37:18 INFO - 2015-11-23 12:37:18,351 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,351 DEBUG : BROWSER_OUTPUT: __start_tp_report 12:37:18 INFO - 2015-11-23 12:37:18,352 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 12:37:18 INFO - 2015-11-23 12:37:18,352 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 12:37:18 INFO - 2015-11-23 12:37:18,352 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 12:37:18 INFO - 2015-11-23 12:37:18,352 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2642.6564546608943;2681.2358477833823;2717.116936995476;2725.168823508829;2746.6841313248974;4497.79759910804;4686.812527498904;4716.268978308359;4722.409698787652;4753.762311884409;4601.79291931863;4631.536846315366;4657.184992626286;4797.2324428091515;4805.8558243252755;4265.083007153461;4361.672874534407;4399.340098985162;4402.823887044515;4442.822287108512;4385.51759306476;4387.298032314814;4426.601605855472;4455.175792478386;4542.09158168366;4179.728317659343;4302.591253830881;4445.199864024475;4453.532379100213;4504.887377815565;4272.46594175728;4386.8903277418;4389.297712366006;4405.691601587891;4423.734575925422;4338.544452832439;4365.519792822787;4369.019138755962;4400.471943366784;4415.933760993587;4383.780810959439;4530.456345238593;4590.081983603292;4626.676132670715;4635.11932732783;5118.97440512795;5156.74216289184;5158.613104017214;5162.019216348919;5172.19830926207;5156.767945442464;5161.535461808456;5168.9741551292;5174.042802081589;5226.738663066832;4522.389477420572;4627.213373726475;4686.835960741358;4778.784954677048;4796.088743138827;5238.764255608507;5248.2390053442805;5264.236685680631;5266.47335266478;5273.868153296122;5043.84868453947;5060.620453466005;5070.3155074064525;5070.442251352349;5110.770015349318;4738.526147385234;4931.4821943696115;4947.975260123676;5064.1897296433135;5136.409312928986;4948.4309304429735;4979.029089327546;4980.05378977993;4983.25251212321;4988.800447982113;4943.975280123576;4945.67853089548;4947.802087916443;4961.5286547777905;4986.853023804545;4065.2276067547073;4106.691998100155;4176.373543968369;4197.517285512145;4213.115245798416;3706.092007458136;3711.2763011212555;3717.553893532793;3727.1986522897164;3739.027852758248;4409.559044095565;4434.645228381722;4447.155040542287;4467.776611169428;4483.2602620567895;4854.077725232195;4977.104121258209;4978.103941290602;4981.626378021663;5115.7442127893455;4383.473983121982;4450.577195166518;4477.462704475483;4505.05393867285;4524.163029839425;4482.238019536687;4514.074614703978;4514.503404625489;4519.389882365905;4550.408446901882;4597.517260687579;4665.6967297125575;4716.905661886674;4777.4267087949665;4821.927671085006;5082.085224659597;5152.922706159336;5188.040212560688;5190.922136168036;5204.34945631796;4886.765218256846;4917.409910810726;4919.335889654851;4926.4088309403105;4958.900821983468;4775.71345719258;4873.658843880894;4883.487233840396;5034.2951986721155;5100.107481190851;5028.220625803006;5032.169692000779;5056.292119103402;5067.645264831426;5107;4850.95149048505;4861.51384861511;4866.148424025852;4869.756512174448;4910.165271903714;4743.573078422958;4772.7136371817805;4861.833160041494;4869.6591238612955;4905.656604037683;4774.856754297377;4784.282357646381;4830.516948305141;4838.927416088832;4852.417709874697;4699.03669747694;4942.159832828356;4955.603551715926;4969.925451118163;5007.899842003067;4664.090502352009;4733.763311834326;4770.713757174581;4821.566059054561;4823.348847905488 12:37:18 INFO - 2015-11-23 12:37:18,356 DEBUG : BROWSER_OUTPUT: |1;ext.html;536.179645142931;560.1345920552745;572.5963195946858;577.9856352102063;581.9738111784969;37386.25227495449;37757;37945.24109517808;38157.42763858545;38184;40798.388024179585;40923;41186.64573605434;41355.793221033855;41441;8009.519428834274;8129.5528745918955;8130.674773009073;8140.552269625168;8145.226203510657;7782.18287079857;7914.6438410271385;7916.604169791516;7927.4847134936335;7964.123946365895;7907.6046197690175;8004.399670024743;8004.51972881629;8015.959920200391;8049.154838741935;7937.245961633665;7987.08148562914;8018.118007019223;8031.638576264082;8049.275565199102;7811.4922530035365;7984.321332686729;7986.361091112697;8027.678892844279;8047.597620119029;37907.431388528916;38466.42300365497;38495.61504384948;38527;38628.61371386278;2960.84238888175;3036.802607830484;3076.646185688652;3089.7373723233554;3405.4210784166753;28034.71965280362;28317.57523637147;28476.857615711997;28661;29029.709702903125;3401.3367393358058;3407.5740532433447;3407.931841363159;3510.3330367230146;3579.6599323064265;229700;230382;230662;230846;231553.9999999983;46706.06587868224;47193.76403117963;55974.72012639911;57470.42529574651;57630;57800.71099644475;57840.42159578435;58064;58405.70797145987;58406.12390814141;12408.937955310166;12516.561920332744;12529.498820047096;12564.308963007123;12588.30764307972;9192.264618830477;9231.630734770533;9288.210502107397;9323.72028839136;9379.765505862408;19081.904590477236;19185;19222.903885480482;19314.517137071405;19319.22723091089;7588.354989825927;7843.294103530709;7871.763847084597;7904.841903161904;7905.288524032865;785.1912530094012;842.2588122452203;934.243262957007;963.450833025183;1008.495752123938;25768.355791105372;26285.737142628328;26756.464870702475;26822.5976610351;26901.461970760476;910.0717268386209;914.8719179314901;921.3090182363228;930.7533503621546;943.5942544705842;12818.61544153677;12845.421956012002;12853.614391568268;14050;14818;271852;275192;277972;278446;279808;47088.52911470841;47454.76272618615;47483;47532;47662.28506572404;1129.3224065560762;1137.8008848451489;1144.5936692474218;1145.3128123126057;1176.1590462819127;25351.61972570376;26576.468470630094;26763.19710408691;26981.190564283104;27134.864325678245;39304.60695393124;39648.2070358597;39727.40408893926;39773.60226397699;39784.801075995594;171947.14026429786;173672;173784;174112;174220;28473.430531388844;28951.131466056053;29067;29363.55954660639;29392.41215175727;34853.65146348504;35010.82494587511;35410.29179416346;35473.29053418969;35639.28721425609;29972.250693732833;30342;30597.388052239276;31131.377372452876;31405.371892562478;30489.847550762104;30666.540001900437;30704.385912282076;30794.538081928342;32166.83916580402;30662.233444164074;30834.229144271572;30943.381132377675;31155;31270;25673.871630641726;27124.593131102654;27597.448051038464;28032.43935121327;28275.434491309647;23408.6488702673;23476.178333758235;23595.882020589786;23791.405214869766;23899.641505377087 12:37:18 INFO - 2015-11-23 12:37:18,357 DEBUG : BROWSER_OUTPUT: |2;jquery.html;343.19691920905075;343.5516650770743;343.5585272924292;345.4748781851584;347.156409923885;12598.559050433236;12992.155509891874;15111.697766044672;15294.770578441332;16998.150092495358;12759.298238596897;13604.591862244124;13807.171569705799;14954.850451495482;15106.244687765622;4921.70469771814;5036.320096786942;5056.6713163644245;5057.468965758598;5065.240213967897;5080.1617733074;5083.491650834905;5083.898322033557;5088.5929125670045;5280.102382594949;5189.325387699594;5227.660202086871;5233.764480598363;5269.446708095633;5282.286891269668;5876.882462350751;5881.206037184989;5884.235049443545;5885.970570147165;5895.233619629442;5101.7194054327;5120.283160357553;5147.253648220987;5154.226865970097;5190.92213616796;11687.707807304885;11872.703182420422;11875.109366797526;11951.402429878472;14269.78595321071;1759.4018033868417;1762.6562820250056;1794.605186858889;1807.764990551233;1896.5543097372106;8585.527795971218;8936.41913275635;9070.138336857988;9130.863037054449;9341.205997490222;1729;1784.0722824131378;1790.6239689665185;1790.8209179082119;1829.1768704083083;54819.725901370635;55047.449525505035;55064;56393.71803140999;56624.43375566274;9600.375975561567;9781;9791.853122203172;9828.361156524803;9907.356021858555;12472.937635311766;12482.188657737219;12490.625281241577;12505.124641275024;12531;6374.139491168726;6436.098946147543;6609.20689517261;6685.966570167118;6775.390214880685;6279.937200627935;6315.936840631627;6319.462845658079;6328.11406403104;6367.235931688135;4174.436451079066;4235.4917409911;4294.957050429456;4302.870913872589;4310.224159651293;1686.544632949097;1729.7405389191722;1738.9304427822744;1750.88619239749;1763.453329467869;796.9036867960151;820.7332616899531;881.9592880401188;902.1835239108617;999.3703966501204;15478.5356439307;15580.688386232212;15646.374145034299;15825.366985320457;16039;808.7897146741772;835.849547081519;838.4340570115148;843.9915600843913;855.9529225892511;9068.093190680878;9079.228265597498;9143.908560914439;9162.541872906328;9341.626334946663;488414;492480;495275.1889924435;495616;503310;67389.32610673929;68635;68827.65586172037;69566;69967.30032699608;1042.7601651620018;1052.7947050325113;1054.2725519391595;1057.4818339013827;1073.9624113156;13341;14087.929560352133;14114;14267.571972840831;14269.357878895682;28137.296567585974;28544.57183142213;28645.99739009125;29089.418211635224;32817.67182328146;39011;39540.80229598834;39569.60430395774;41465.58534414617;42855.78572107244;8469.703560375357;8661.740147795575;9129.45223286605;9135.40619859707;9143.13140251675;9404.482753448627;9670.129688328085;9856.901430985597;10328.483575821028;10500.422476763852;9135.360524763202;9367.297452691211;9468.14786669203;9688.660896868576;9699.369540979813;8623.913760862311;8991.955040224757;9007.954960225157;9171.495567743572;9638.036196380306;8990.370674052754;8994.550272486218;9400.482973436527;9917.702468925943;9971.252156088467;13875.791863122264;13902.930485347508;14429.20639364845;14504.492342767953;14584.781228281372;14541.345639446461;14681.045732027384;14821.703565928405;15064.096154230781;15327.770083448535 12:37:18 INFO - 2015-11-23 12:37:18,358 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1484.2207840883527;1616.11921502781;1643.6768401436846;1668.449411694141;1689.4593730006395;6152.723127459264;6304.117423560705;6433.5818171818855;6685.331466853312;6698.966505167474;6458.580192287498;6536.836579085525;6569.40875321221;6575.14523111996;6598.505112116586;2008.02610733794;2042.9897850510802;2052.9589408211828;2054.3734161080865;2055.0341339570455;2051.1282704850455;2067.576146889884;2071.420002399323;2082.125507286943;2096.9895150524226;2025.4531276555322;2028.563858770364;2031.989840050805;2050.169681279084;2059.258666879922;2047.7030830529563;2078.4388215181966;2080.906359213839;2082.250389859649;2088.603165398569;2034.5727397246596;2038.5413282011577;2058.9794102058936;2059.104289633999;2077.5637116205617;6563.967180164069;6573.1783527059115;6587.571807832475;6608.339166083401;6624.86750264992;4008.2785098682225;4060.167665628539;4078.12320351123;4093.1813637272367;4111.075008123178;2684.4362683836416;2707.2690373599016;2708.783297336228;2780.8470534120615;2822.6048353230562;842.8482873082843;857.3869683176558;858.3433673239977;862.6420035685184;889.4485419040236;8042.879356809653;8051.154628764012;8054.476459030145;8112.31045361145;8132.837343253161;3511.122219445139;3529.6646818552194;3560.3769340365334;3561.3233485637647;3566.1262990567475;6808.285130061371;6810.31896810315;6822.147231596051;6833.726650934006;6833.931660683429;3824.101336185994;3835.4055121456217;3838.1556057667267;3854.8265328060306;3876.592957739453;3089.3666798306294;3121.8439078046463;3415.7608967372544;3490.3019396120876;3502.124468882779;3025.6217972753407;3070.401271752032;3076.553899684533;3079.3687294104657;3106.39425312062;941.1341565759518;950.2113246005798;953.137410643355;957.2820384711466;960.9471479068578;1094.1465656787718;1115.2694984784978;1135.40391294571;1148.9712757181137;1158.6176561734608;6195.938040619626;6220.7511699531515;6252.5935814171935;6255.718492667841;6260.812175634738;1017.3539802225492;1095.0801326885296;1096.3257596578046;1126.9380184089953;1128.5260190719916;4855.830045948375;4879.780409881564;4890.217565189552;4913.385826771653;4937.23472861707;7323.2676732326345;7446.739364122338;7447.031885854804;7579.355754760797;7720.45956783031;7390.852182956311;7400.555966642019;7414.6292685365515;7434.888476672854;7435.962820185864;6139.324674285825;6252.5935814171935;6259.2488901332135;6279.560430769893;6287.402696743802;6201.3178550358525;6201.565890387629;6207.7584483102655;6235.033569796688;6255.812325630239;6796.116504854535;6931.965340173469;6940.27127151662;7133.785986420416;7155.177154627285;7077.5399599025895;7180.31786980236;7184.568925864465;7281.927180728125;7298.416126709744;5206.401263854706;5296.655717378358;5824.15549745293;5902.2622172228475;5906.763729450946;5795.594308398372;6116.847078823065;6139.96930015365;6149.938500614937;6164.537659675632;5664.0937450007805;5785;5800.24596802413;5813.069908814569;6017.127516509994;5721.113227449752;5723.942760572508;5820.534357251495;5866.5893387462465;5891.086881533369;5685.602007859576;5687.886242275049;5692.544596432358;5738.368779434342;5942.227510423617;5354.9464505354445;5386.461353864739;5408.161734931092;5423.511883930465;5426;5490.752916118864;5555.472230138131;5565.888682226252;5566.415526369673;5571.637843540157 12:37:18 INFO - 2015-11-23 12:37:18,359 DEBUG : BROWSER_OUTPUT: |4;prototype.html;309.66401454421947;313.3357282560971;315.17581524313925;317.2275509135256;319.09854660583846;5517.806876759314;5640.605157638967;5676.744546495407;5683.744231509587;5787.47912687858;5547.8890422191635;5601.075822489284;5638.295213098363;5649.971750141243;5654.293213348332;4302.806373713191;4320.94136936451;4323.870283891489;4329.5021072576665;4342.565743425664;4335.111302183061;4343.739375637456;4349.717268377562;4349.7390156590545;4354.477462704464;4057.9797101014456;4145.31602285624;4195;4309.2889673204045;4313.094250207445;4158.2307273154565;4184.3305071188615;4185.895352616179;4186.539480657125;4189.183109293689;3550.236699109678;3555.2711694102645;3563.6436356364156;3566.0549954261883;3576.2847430513743;5356.946430535684;5372.301600791872;5383.16560933056;5391.167003218924;5395.730213489349;4776.737279449629;4786.928196077061;4790.161721698689;4792.041591681677;4985.451600323961;5736.627119237278;5841.766329346821;5853.385394533555;5883.61756485827;5926.733297001645;4047.1298670785923;4079.2453396121514;4080.489938757655;4081.1837632473625;4081.3061779497557;6141.815745527641;6211.19254496917;6213.316535181127;6216.129741836146;6223.533235007438;4132.380142978577;4208.158368326347;4214.3889136075095;4217.156568686214;4217.894552636209;4280.101178752497;4280.379344995021;4281.614654681093;4282.935755963663;4284.10033892886;4892.241702536113;4919.77860996256;4921;4929.507049295042;4930.8767280818265;5872.265966754156;5901.3508514063415;5902.675352855634;5909.261342332208;5915.40845915405;1476.217604669527;1511.4483213626947;1517.2186324043128;1521.0949485056374;1527.1676936069869;935.8081593273499;1006.2503434941016;1012.7670635753818;1024.702836177515;1026.3072426112344;5056.544910958031;5057.367829021372;5059.822906198266;5084.389873215164;5090.389153301628;5998.550108741774;6019.067044608093;6038.365971572922;6038.547108966845;6045.093236014633;5046.545810877039;5074.771635276422;5076.060928728197;5082.313887625197;5085.949140508622;3230.2247460609283;3289.588801399825;3312;3312.370649576621;3327.9833600832326;5716.857078573069;5729.226554415184;5729.3984131665575;5745.3105627324985;5755.021646320136;6285.308616052231;6313.337099604475;6313.463355614732;6315.305316415191;6319.210098737658;5676.68778217202;5694.914576281359;5764.250647415809;5783.3638299787835;5852.531797456279;6188.721507532262;6208.379162083756;6217.502599792097;6227.470664993526;6247.0629405589525;6057.061155520902;6072.574919755752;6073.696315184311;6074.149619053424;6076.969615152073;5610.691411972381;5808.5062769665055;5840.766369345179;5847.590668653153;5884.58807883444;4160.147169830238;4208.452901122834;4214.283571792741;4223.852165174204;4225.640820530167;6221.5333849962335;6225.128482012612;6239.064140378798;6244.313125556276;6248.0940263660605;5948.345681975065;5972;5980.192673988956;5998.400159984141;6007.669578173068;5783.537317014545;5940.732667030081;5954.940450595439;5965.8806823862415;5967.850803729942;5797.072468405035;5832.94167058324;5841.678707670949;5842.152887831156;5863.648181109147;5976.731047102804;5985.461308482258;6019.6990150493175;6024.036154215304;6026.7589296429405;5667.291588551431;5831.271091113611;5831.562632802642;5849.151872978479;5865.442782935615 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: |5;yui.html;672.4250765595416;711.654847399011;717.8205448637841;767.1024900865987;781.2460975158972;11477.942610286947;11692.473838677259;11795.292282463059;11856.170068095225;11910.880891191086;12033.51865925362;12165.270083794956;13687.93156034221;13845.515406960758;13939.790903136462;783.0837919634042;790.3677058353323;804.3283857978565;806.3226889412892;810.1655295046082;798.4490701416033;800.6197056398222;803.9276465118138;805.3758337288618;805.5488926201317;823.4565186976597;829.2578142562403;829.6100832608664;829.6888666749969;831.1024093978489;821.8315245374683;822.153182222312;824.0482243009334;824.085265355455;826.8222332198546;608.248812716295;609.0529227051933;612.3967891626744;612.6140531465148;612.6354818882758;11646.126540509496;11655.59205427806;11748.823767643493;11764.352960587164;11810.173287869853;10817.945910270477;10998.505067271992;11034.944825275903;11227;11461.713457163554;9004.459732416077;9585;9596.856047159297;9656.903430965742;9926.404415735078;3230.8384580771103;3246.610406751205;3255.9023229303157;3296.3901678189372;3331.1505566080737;41379.75860724153;41603;41766.1646767066;41908.79045604783;42070.579294206975;9189.632414703337;9227.723168304961;9250.121238482334;9276.397034192756;9318.254539636948;16508.504744857673;16534.66930661404;16536;16547.669046619;16555.08947007902;5753.884922301614;5845.503132233723;6102.664353460514;6175.69121543921;6178.165947597017;3513.8243087845503;3559.2169722660974;3575.1955809942556;3579.2483578448296;3599.6400359963795;2705.9594106088425;2744.31392151962;2776.2642899631614;2777.388974425623;2780.3744157564793;491.5821551681114;493.62484511770595;497.4900726755105;497.9950200498021;504.2360823352624;451.6432018705186;460.94007778989186;478.09401184754694;541.4676465602336;595.9910601340983;7360.190379058299;7807.258310460497;8039.437239393304;8191.918080819235;8291.170882911661;470.6117453101205;477.1697246790629;548.506344290142;554.1742803223249;617.7930393318198;3595.1371670799344;3741.345264578688;3792.27946690128;3819.4652748614662;3870.9806450967567;51800;51818.48181518212;52155.47844521582;52318.738406307726;52380.73809631004;45830;46412;46447;46585.30122048172;46609.5339046612;41373;42448.78775606102;42802.999999999374;43165.78417107894;43277.783611081744;7414.962925185555;7611;7653.617319134132;7713.498622589514;7788.221177882393;29675.10974670677;29682.257943551584;29746.85126574353;29807.701922980494;30235.09294721162;37019;37933.620663794114;41417.58582414137;42020.579794201665;42173.367399488416;8571.914280857362;9167.08329167078;9227.21568666644;9281.211097056826;9416.81166376655;10309.913148838865;10401.21990850674;10452.111570516592;10500.78998420012;10581.153507719519;9901.257405694458;9912;10249.077583017564;10308.793824123626;10394.688159355232;9028.774280643036;9106.590203440994;9329.860052099088;9394.342396032485;9400.905990940004;9403.905960940303;9420.152186303265;9708.6116555337;9752.317337786288;9927.056929591678;8282.751517454486;8469.66121355139;8478.23695867375;8483.194096560817;8537.701180458655;8135.79660508492;8399.496030238206;8846.823063538823;9150;9267.258619310303 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: __end_tp_report 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: __start_cc_report 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,326 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: __end_cc_report 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: __startTimestamp1448311038349__endTimestamp 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: Number of tests: 6 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,360 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4669.38 Median:4775.71 stddev:486.11 (10.2%) stddev-sans-first:460.86 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: Values: 2642.7 2681.2 2717.1 2725.2 2746.7 4497.8 4686.8 4716.3 4722.4 4753.8 4601.8 4631.5 4657.2 4797.2 4805.9 4265.1 4361.7 4399.3 4402.8 4442.8 4385.5 4387.3 4426.6 4455.2 4542.1 4179.7 4302.6 4445.2 4453.5 4504.9 4272.5 4386.9 4389.3 4405.7 4423.7 4338.5 4365.5 4369.0 4400.5 4415.9 4383.8 4530.5 4590.1 4626.7 4635.1 5119.0 5156.7 5158.6 5162.0 5172.2 5156.8 5161.5 5169.0 5174.0 5226.7 4522.4 4627.2 4686.8 4778.8 4796.1 5238.8 5248.2 5264.2 5266.5 5273.9 5043.8 5060.6 5070.3 5070.4 5110.8 4738.5 4931.5 4948.0 5064.2 5136.4 4948.4 4979.0 4980.1 4983.3 4988.8 4944.0 4945.7 4947.8 4961.5 4986.9 4065.2 4106.7 4176.4 4197.5 4213.1 3706.1 3711.3 3717.6 3727.2 3739.0 4409.6 4434.6 4447.2 4467.8 4483.3 4854.1 4977.1 4978.1 4981.6 5115.7 4383.5 4450.6 4477.5 4505.1 4524.2 4482.2 4514.1 4514.5 4519.4 4550.4 4597.5 4665.7 4716.9 4777.4 4821.9 5082.1 5152.9 5188.0 5190.9 5204.3 4886.8 4917.4 4919.3 4926.4 4958.9 4775.7 4873.7 4883.5 5034.3 5100.1 5028.2 5032.2 5056.3 5067.6 5107.0 4851.0 4861.5 4866.1 4869.8 4910.2 4743.6 4772.7 4861.8 4869.7 4905.7 4774.9 4784.3 4830.5 4838.9 4852.4 4699.0 4942.2 4955.6 4969.9 5007.9 4664.1 4733.8 4770.7 4821.6 4823.3 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:38844.05 Median:19260.58 stddev:60225.24 (312.7%) stddev-sans-first:60325.50 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: Values: 536.2 560.1 572.6 578.0 582.0 37386.3 37757.0 37945.2 38157.4 38184.0 40798.4 40923.0 41186.6 41355.8 41441.0 8009.5 8129.6 8130.7 8140.6 8145.2 7782.2 7914.6 7916.6 7927.5 7964.1 7907.6 8004.4 8004.5 8016.0 8049.2 7937.2 7987.1 8018.1 8031.6 8049.3 7811.5 7984.3 7986.4 8027.7 8047.6 37907.4 38466.4 38495.6 38527.0 38628.6 2960.8 3036.8 3076.6 3089.7 3405.4 28034.7 28317.6 28476.9 28661.0 29029.7 3401.3 3407.6 3407.9 3510.3 3579.7 229700.0 230382.0 230662.0 230846.0 231554.0 46706.1 47193.8 55974.7 57470.4 57630.0 57800.7 57840.4 58064.0 58405.7 58406.1 12408.9 12516.6 12529.5 12564.3 12588.3 9192.3 9231.6 9288.2 9323.7 9379.8 19081.9 19185.0 19222.9 19314.5 19319.2 7588.4 7843.3 7871.8 7904.8 7905.3 785.2 842.3 934.2 963.5 1008.5 25768.4 26285.7 26756.5 26822.6 26901.5 910.1 914.9 921.3 930.8 943.6 12818.6 12845.4 12853.6 14050.0 14818.0 271852.0 275192.0 277972.0 278446.0 279808.0 47088.5 47454.8 47483.0 47532.0 47662.3 1129.3 1137.8 1144.6 1145.3 1176.2 25351.6 26576.5 26763.2 26981.2 27134.9 39304.6 39648.2 39727.4 39773.6 39784.8 171947.1 173672.0 173784.0 174112.0 174220.0 28473.4 28951.1 29067.0 29363.6 29392.4 34853.7 35010.8 35410.3 35473.3 35639.3 29972.3 30342.0 30597.4 31131.4 31405.4 30489.8 30666.5 30704.4 30794.5 32166.8 30662.2 30834.2 30943.4 31155.0 31270.0 25673.9 27124.6 27597.4 28032.4 28275.4 23408.6 23476.2 23595.9 23791.4 23899.6 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:25794.99 Median:5061.35 stddev:80848.84 (1597.4%) stddev-sans-first:81053.05 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: Values: 343.2 343.6 343.6 345.5 347.2 12598.6 12992.2 15111.7 15294.8 16998.2 12759.3 13604.6 13807.2 14954.9 15106.2 4921.7 5036.3 5056.7 5057.5 5065.2 5080.2 5083.5 5083.9 5088.6 5280.1 5189.3 5227.7 5233.8 5269.4 5282.3 5876.9 5881.2 5884.2 5886.0 5895.2 5101.7 5120.3 5147.3 5154.2 5190.9 11687.7 11872.7 11875.1 11951.4 14269.8 1759.4 1762.7 1794.6 1807.8 1896.6 8585.5 8936.4 9070.1 9130.9 9341.2 1729.0 1784.1 1790.6 1790.8 1829.2 54819.7 55047.4 55064.0 56393.7 56624.4 9600.4 9781.0 9791.9 9828.4 9907.4 12472.9 12482.2 12490.6 12505.1 12531.0 6374.1 6436.1 6609.2 6686.0 6775.4 6279.9 6315.9 6319.5 6328.1 6367.2 4174.4 4235.5 4295.0 4302.9 4310.2 1686.5 1729.7 1738.9 1750.9 1763.5 796.9 820.7 882.0 902.2 999.4 15478.5 15580.7 15646.4 15825.4 16039.0 808.8 835.8 838.4 844.0 856.0 9068.1 9079.2 9143.9 9162.5 9341.6 488414.0 492480.0 495275.2 495616.0 503310.0 67389.3 68635.0 68827.7 69566.0 69967.3 1042.8 1052.8 1054.3 1057.5 1074.0 13341.0 14087.9 14114.0 14267.6 14269.4 28137.3 28544.6 28646.0 29089.4 32817.7 39011.0 39540.8 39569.6 41465.6 42855.8 8469.7 8661.7 9129.5 9135.4 9143.1 9404.5 9670.1 9856.9 10328.5 10500.4 9135.4 9367.3 9468.1 9688.7 9699.4 8623.9 8992.0 9008.0 9171.5 9638.0 8990.4 8994.6 9400.5 9917.7 9971.3 13875.8 13902.9 14429.2 14504.5 14584.8 14541.3 14681.0 14821.7 15064.1 15327.8 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4549.10 Median:5706.83 stddev:2221.12 (38.9%) stddev-sans-first:2215.41 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: Values: 1484.2 1616.1 1643.7 1668.4 1689.5 6152.7 6304.1 6433.6 6685.3 6699.0 6458.6 6536.8 6569.4 6575.1 6598.5 2008.0 2043.0 2053.0 2054.4 2055.0 2051.1 2067.6 2071.4 2082.1 2097.0 2025.5 2028.6 2032.0 2050.2 2059.3 2047.7 2078.4 2080.9 2082.3 2088.6 2034.6 2038.5 2059.0 2059.1 2077.6 6564.0 6573.2 6587.6 6608.3 6624.9 4008.3 4060.2 4078.1 4093.2 4111.1 2684.4 2707.3 2708.8 2780.8 2822.6 842.8 857.4 858.3 862.6 889.4 8042.9 8051.2 8054.5 8112.3 8132.8 3511.1 3529.7 3560.4 3561.3 3566.1 6808.3 6810.3 6822.1 6833.7 6833.9 3824.1 3835.4 3838.2 3854.8 3876.6 3089.4 3121.8 3415.8 3490.3 3502.1 3025.6 3070.4 3076.6 3079.4 3106.4 941.1 950.2 953.1 957.3 960.9 1094.1 1115.3 1135.4 1149.0 1158.6 6195.9 6220.8 6252.6 6255.7 6260.8 1017.4 1095.1 1096.3 1126.9 1128.5 4855.8 4879.8 4890.2 4913.4 4937.2 7323.3 7446.7 7447.0 7579.4 7720.5 7390.9 7400.6 7414.6 7434.9 7436.0 6139.3 6252.6 6259.2 6279.6 6287.4 6201.3 6201.6 6207.8 6235.0 6255.8 6796.1 6932.0 6940.3 7133.8 7155.2 7077.5 7180.3 7184.6 7281.9 7298.4 5206.4 5296.7 5824.2 5902.3 5906.8 5795.6 6116.8 6140.0 6149.9 6164.5 5664.1 5785.0 5800.2 5813.1 6017.1 5721.1 5723.9 5820.5 5866.6 5891.1 5685.6 5687.9 5692.5 5738.4 5942.2 5354.9 5386.5 5408.2 5423.5 5426.0 5490.8 5555.5 5565.9 5566.4 5571.6 12:37:18 INFO - 2015-11-23 12:37:18,362 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,364 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4880.57 Median:5574.48 stddev:1460.03 (26.2%) stddev-sans-first:1423.24 12:37:18 INFO - 2015-11-23 12:37:18,364 DEBUG : BROWSER_OUTPUT: Values: 309.7 313.3 315.2 317.2 319.1 5517.8 5640.6 5676.7 5683.7 5787.5 5547.9 5601.1 5638.3 5650.0 5654.3 4302.8 4320.9 4323.9 4329.5 4342.6 4335.1 4343.7 4349.7 4349.7 4354.5 4058.0 4145.3 4195.0 4309.3 4313.1 4158.2 4184.3 4185.9 4186.5 4189.2 3550.2 3555.3 3563.6 3566.1 3576.3 5356.9 5372.3 5383.2 5391.2 5395.7 4776.7 4786.9 4790.2 4792.0 4985.5 5736.6 5841.8 5853.4 5883.6 5926.7 4047.1 4079.2 4080.5 4081.2 4081.3 6141.8 6211.2 6213.3 6216.1 6223.5 4132.4 4208.2 4214.4 4217.2 4217.9 4280.1 4280.4 4281.6 4282.9 4284.1 4892.2 4919.8 4921.0 4929.5 4930.9 5872.3 5901.4 5902.7 5909.3 5915.4 1476.2 1511.4 1517.2 1521.1 1527.2 935.8 1006.3 1012.8 1024.7 1026.3 5056.5 5057.4 5059.8 5084.4 5090.4 5998.6 6019.1 6038.4 6038.5 6045.1 5046.5 5074.8 5076.1 5082.3 5085.9 3230.2 3289.6 3312.0 3312.4 3328.0 5716.9 5729.2 5729.4 5745.3 5755.0 6285.3 6313.3 6313.5 6315.3 6319.2 5676.7 5694.9 5764.3 5783.4 5852.5 6188.7 6208.4 6217.5 6227.5 6247.1 6057.1 6072.6 6073.7 6074.1 6077.0 5610.7 5808.5 5840.8 5847.6 5884.6 4160.1 4208.5 4214.3 4223.9 4225.6 6221.5 6225.1 6239.1 6244.3 6248.1 5948.3 5972.0 5980.2 5998.4 6007.7 5783.5 5940.7 5954.9 5965.9 5967.9 5797.1 5832.9 5841.7 5842.2 5863.6 5976.7 5985.5 6019.7 6024.0 6026.8 5667.3 5831.3 5831.6 5849.2 5865.4 12:37:18 INFO - 2015-11-23 12:37:18,364 DEBUG : BROWSER_OUTPUT: 12:37:18 INFO - 2015-11-23 12:37:18,364 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:12298.46 Median:52237.11 stddev:14313.99 (27.4%) stddev-sans-first:14327.52 12:37:18 INFO - 2015-11-23 12:37:18,364 DEBUG : BROWSER_OUTPUT: Values: 672.4 711.7 717.8 767.1 781.2 11477.9 11692.5 11795.3 11856.2 11910.9 12033.5 12165.3 13687.9 13845.5 13939.8 783.1 790.4 804.3 806.3 810.2 798.4 800.6 803.9 805.4 805.5 823.5 829.3 829.6 829.7 831.1 821.8 822.2 824.0 824.1 826.8 608.2 609.1 612.4 612.6 612.6 11646.1 11655.6 11748.8 11764.4 11810.2 10817.9 10998.5 11034.9 11227.0 11461.7 9004.5 9585.0 9596.9 9656.9 9926.4 3230.8 3246.6 3255.9 3296.4 3331.2 41379.8 41603.0 41766.2 41908.8 42070.6 9189.6 9227.7 9250.1 9276.4 9318.3 16508.5 16534.7 16536.0 16547.7 16555.1 5753.9 5845.5 6102.7 6175.7 6178.2 3513.8 3559.2 3575.2 3579.2 3599.6 2706.0 2744.3 2776.3 2777.4 2780.4 491.6 493.6 497.5 498.0 504.2 451.6 460.9 478.1 541.5 596.0 7360.2 7807.3 8039.4 8191.9 8291.2 470.6 477.2 548.5 554.2 617.8 3595.1 3741.3 3792.3 3819.5 3871.0 51800.0 51818.5 52155.5 52318.7 52380.7 45830.0 46412.0 46447.0 46585.3 46609.5 41373.0 42448.8 42803.0 43165.8 43277.8 7415.0 7611.0 7653.6 7713.5 7788.2 29675.1 29682.3 29746.9 29807.7 30235.1 37019.0 37933.6 41417.6 42020.6 42173.4 8571.9 9167.1 9227.2 9281.2 9416.8 10309.9 10401.2 10452.1 10500.8 10581.2 9901.3 9912.0 10249.1 10308.8 10394.7 9028.8 9106.6 9329.9 9394.3 9400.9 9403.9 9420.2 9708.6 9752.3 9927.1 8282.8 8469.7 8478.2 8483.2 8537.7 8135.8 8399.5 8846.8 9150.0 9267.3 12:37:18 INFO - 2015-11-23 12:37:18,364 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 12:37:18 INFO - 2015-11-23 12:37:18,364 DEBUG : BROWSER_OUTPUT: 12:37:19 INFO - 2015-11-23 12:37:19,097 INFO : Browser exited with error code: 0 12:37:19 INFO - 2015-11-23 12:37:19,119 INFO : Completed test dromaeo_css (00:18:37) 12:37:19 INFO - 2015-11-23 12:37:19,119 INFO : Starting test kraken 12:37:19 INFO - 2015-11-23 12:37:19,119 DEBUG : operating with platform_type : linux_ 12:37:19 INFO - 2015-11-23 12:37:19,119 INFO : Initialising browser for kraken test... 12:37:19 INFO - 2015-11-23 12:37:19,125 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGyRhcb/profile http://localhost:43424/getInfo.html 12:37:24 INFO - 2015-11-23 12:37:24,531 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 12:37:24 INFO - 2015-11-23 12:37:24,531 DEBUG : BROWSER_OUTPUT: colorDepth:24 12:37:24 INFO - 2015-11-23 12:37:24,531 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 12:37:24 INFO - 2015-11-23 12:37:24,531 DEBUG : BROWSER_OUTPUT: __metrics 12:37:25 INFO - 2015-11-23 12:37:25,725 INFO : Browser initialized. 12:37:25 INFO - 2015-11-23 12:37:25,726 INFO : Running cycle 1/1 for kraken test... 12:37:25 INFO - 2015-11-23 12:37:25,726 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGyRhcb/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 12:37:37 INFO - 2015-11-23 12:37:37,680 DEBUG : BROWSER_OUTPUT: RSS: Main: 141647872 12:37:37 INFO - 2015-11-23 12:37:37,680 DEBUG : BROWSER_OUTPUT: 12:37:40 INFO - 2015-11-23 12:37:40,243 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:43424/tests/kraken/driver.html?testName=audio-beat-detection) 12:37:40 INFO - 2015-11-23 12:37:40,857 DEBUG : BROWSER_OUTPUT: RSS: Main: 141664256 12:37:40 INFO - 2015-11-23 12:37:40,857 DEBUG : BROWSER_OUTPUT: 12:37:43 INFO - 2015-11-23 12:37:43,620 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:43424/tests/kraken/driver.html?testName=audio-dft) 12:37:44 INFO - 2015-11-23 12:37:44,221 DEBUG : BROWSER_OUTPUT: RSS: Main: 142258176 12:37:44 INFO - 2015-11-23 12:37:44,221 DEBUG : BROWSER_OUTPUT: 12:37:47 INFO - 2015-11-23 12:37:47,129 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:43424/tests/kraken/driver.html?testName=audio-fft) 12:37:47 INFO - 2015-11-23 12:37:47,715 DEBUG : BROWSER_OUTPUT: RSS: Main: 135467008 12:37:47 INFO - 2015-11-23 12:37:47,715 DEBUG : BROWSER_OUTPUT: 12:37:49 INFO - 2015-11-23 12:37:49,869 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:43424/tests/kraken/driver.html?testName=audio-oscillator) 12:37:50 INFO - 2015-11-23 12:37:50,492 DEBUG : BROWSER_OUTPUT: RSS: Main: 136904704 12:37:50 INFO - 2015-11-23 12:37:50,493 DEBUG : BROWSER_OUTPUT: 12:37:52 INFO - 2015-11-23 12:37:52,733 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:43424/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:37:53 INFO - 2015-11-23 12:37:53,314 DEBUG : BROWSER_OUTPUT: RSS: Main: 137555968 12:37:53 INFO - 2015-11-23 12:37:53,316 DEBUG : BROWSER_OUTPUT: 12:37:56 INFO - 2015-11-23 12:37:56,396 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:43424/tests/kraken/driver.html?testName=imaging-darkroom) 12:37:56 INFO - 2015-11-23 12:37:56,998 DEBUG : BROWSER_OUTPUT: RSS: Main: 137883648 12:37:56 INFO - 2015-11-23 12:37:56,998 DEBUG : BROWSER_OUTPUT: 12:38:00 INFO - 2015-11-23 12:38:00,461 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:43424/tests/kraken/driver.html?testName=imaging-desaturate) 12:38:01 INFO - 2015-11-23 12:38:01,068 DEBUG : BROWSER_OUTPUT: RSS: Main: 136507392 12:38:01 INFO - 2015-11-23 12:38:01,068 DEBUG : BROWSER_OUTPUT: 12:38:03 INFO - 2015-11-23 12:38:03,954 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:43424/tests/kraken/driver.html?testName=json-parse-financial) 12:38:04 INFO - 2015-11-23 12:38:04,547 DEBUG : BROWSER_OUTPUT: RSS: Main: 137355264 12:38:04 INFO - 2015-11-23 12:38:04,547 DEBUG : BROWSER_OUTPUT: 12:38:06 INFO - 2015-11-23 12:38:06,346 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:43424/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:38:06 INFO - 2015-11-23 12:38:06,935 DEBUG : BROWSER_OUTPUT: RSS: Main: 138199040 12:38:06 INFO - 2015-11-23 12:38:06,935 DEBUG : BROWSER_OUTPUT: 12:38:08 INFO - 2015-11-23 12:38:08,810 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:38:09 INFO - 2015-11-23 12:38:09,424 DEBUG : BROWSER_OUTPUT: RSS: Main: 138936320 12:38:09 INFO - 2015-11-23 12:38:09,424 DEBUG : BROWSER_OUTPUT: 12:38:11 INFO - 2015-11-23 12:38:11,617 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:38:12 INFO - 2015-11-23 12:38:12,198 DEBUG : BROWSER_OUTPUT: RSS: Main: 138960896 12:38:12 INFO - 2015-11-23 12:38:12,198 DEBUG : BROWSER_OUTPUT: 12:38:14 INFO - 2015-11-23 12:38:14,795 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:38:15 INFO - 2015-11-23 12:38:15,389 DEBUG : BROWSER_OUTPUT: RSS: Main: 139300864 12:38:15 INFO - 2015-11-23 12:38:15,389 DEBUG : BROWSER_OUTPUT: 12:38:18 INFO - 2015-11-23 12:38:18,029 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:38:18 INFO - 2015-11-23 12:38:18,623 DEBUG : BROWSER_OUTPUT: RSS: Main: 139165696 12:38:18 INFO - 2015-11-23 12:38:18,623 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,356 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:43424/tests/kraken/driver.html?testName=ai-astar) 12:38:20 INFO - 2015-11-23 12:38:20,606 DEBUG : BROWSER_OUTPUT: RSS: Main: 139481088 12:38:20 INFO - 2015-11-23 12:38:20,606 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,609 DEBUG : BROWSER_OUTPUT: __start_tp_report 12:38:20 INFO - 2015-11-23 12:38:20,609 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 12:38:20 INFO - 2015-11-23 12:38:20,610 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 12:38:20 INFO - 2015-11-23 12:38:20,610 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 12:38:20 INFO - 2015-11-23 12:38:20,610 DEBUG : BROWSER_OUTPUT: |0;ai-astar;112;106;112;112;112;126;114;112;113;115 12:38:20 INFO - 2015-11-23 12:38:20,610 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;161;131;152;169;146;167;155;140;174;133 12:38:20 INFO - 2015-11-23 12:38:20,610 DEBUG : BROWSER_OUTPUT: |2;audio-dft;163;164;163;166;162;164;174;160;164;163 12:38:20 INFO - 2015-11-23 12:38:20,610 DEBUG : BROWSER_OUTPUT: |3;audio-fft;74;74;73;72;74;75;128;73;73;74 12:38:20 INFO - 2015-11-23 12:38:20,610 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;93;92;124;90;91;92;124;92;93;131 12:38:20 INFO - 2015-11-23 12:38:20,611 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;110;111;110;113;110;109;110;110;110;109 12:38:20 INFO - 2015-11-23 12:38:20,611 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;147;146;147;147;147;149;147;148;150;147 12:38:20 INFO - 2015-11-23 12:38:20,611 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;96;97;97;96;96;96;96;97;96 12:38:20 INFO - 2015-11-23 12:38:20,611 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;72;72;73;72;73;72;73;73;73;73 12:38:20 INFO - 2015-11-23 12:38:20,611 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;69;69;69;69;69;68;69;68;70 12:38:20 INFO - 2015-11-23 12:38:20,611 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;91;83;83;86;84;91;87;86;83;82 12:38:20 INFO - 2015-11-23 12:38:20,611 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;121;126;133;133;129;123;131;124;127;132 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;142;138;161;147;151;134;166;150;147;150 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;69;70;70;71;70;69;69;69;69;69 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: __end_tp_report 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: __start_cc_report 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,795 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: __end_cc_report 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: __startTimestamp1448311100608__endTimestamp 12:38:20 INFO - 2015-11-23 12:38:20,612 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: Number of tests: 14 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:113.40 Median:112.50 stddev:5.02 (4.5%) stddev-sans-first:5.29 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: Values: 112.0 106.0 112.0 112.0 112.0 126.0 114.0 112.0 113.0 115.0 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:152.80 Median:158.00 stddev:15.14 (9.6%) stddev-sans-first:15.77 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: Values: 161.0 131.0 152.0 169.0 146.0 167.0 155.0 140.0 174.0 133.0 12:38:20 INFO - 2015-11-23 12:38:20,616 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:164.30 Median:164.00 stddev:3.74 (2.3%) stddev-sans-first:3.94 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: Values: 163.0 164.0 163.0 166.0 162.0 164.0 174.0 160.0 164.0 163.0 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:79.00 Median:74.00 stddev:17.24 (23.3%) stddev-sans-first:18.19 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: Values: 74.0 74.0 73.0 72.0 74.0 75.0 128.0 73.0 73.0 74.0 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:102.20 Median:92.00 stddev:16.78 (18.2%) stddev-sans-first:17.47 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: Values: 93.0 92.0 124.0 90.0 91.0 92.0 124.0 92.0 93.0 131.0 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:110.20 Median:110.00 stddev:1.14 (1.0%) stddev-sans-first:1.20 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: Values: 110.0 111.0 110.0 113.0 110.0 109.0 110.0 110.0 110.0 109.0 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.50 Median:147.00 stddev:1.18 (0.8%) stddev-sans-first:1.24 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: Values: 147.0 146.0 147.0 147.0 147.0 149.0 147.0 148.0 150.0 147.0 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,617 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: Values: 96.0 96.0 97.0 97.0 96.0 96.0 96.0 96.0 97.0 96.0 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:72.60 Median:73.00 stddev:0.52 (0.7%) stddev-sans-first:0.50 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: Values: 72.0 72.0 73.0 72.0 73.0 72.0 73.0 73.0 73.0 73.0 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.80 Median:69.00 stddev:0.63 (0.9%) stddev-sans-first:0.60 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: Values: 68.0 69.0 69.0 69.0 69.0 69.0 68.0 69.0 68.0 70.0 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:85.60 Median:86.00 stddev:3.27 (3.8%) stddev-sans-first:2.83 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: Values: 91.0 83.0 83.0 86.0 84.0 91.0 87.0 86.0 83.0 82.0 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,618 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:127.90 Median:130.00 stddev:4.36 (3.4%) stddev-sans-first:3.84 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: Values: 121.0 126.0 133.0 133.0 129.0 123.0 131.0 124.0 127.0 132.0 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:148.60 Median:150.00 stddev:9.66 (6.4%) stddev-sans-first:9.95 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: Values: 142.0 138.0 161.0 147.0 151.0 134.0 166.0 150.0 147.0 150.0 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.50 Median:69.50 stddev:0.71 (1.0%) stddev-sans-first:0.73 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: Values: 69.0 70.0 70.0 71.0 70.0 69.0 69.0 69.0 69.0 69.0 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 12:38:20 INFO - 2015-11-23 12:38:20,619 DEBUG : BROWSER_OUTPUT: 12:38:21 INFO - 2015-11-23 12:38:21,549 INFO : Browser exited with error code: 0 12:38:21 INFO - 2015-11-23 12:38:21,603 INFO : Completed test kraken (00:01:02) 12:38:21 INFO - 2015-11-23 12:38:21,603 INFO : Starting test v8_7 12:38:21 INFO - 2015-11-23 12:38:21,603 DEBUG : operating with platform_type : linux_ 12:38:21 INFO - 2015-11-23 12:38:21,603 INFO : Initialising browser for v8_7 test... 12:38:21 INFO - 2015-11-23 12:38:21,609 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpu1My0O/profile http://localhost:43424/getInfo.html 12:38:26 INFO - 2015-11-23 12:38:26,792 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 12:38:26 INFO - 2015-11-23 12:38:26,792 DEBUG : BROWSER_OUTPUT: colorDepth:24 12:38:26 INFO - 2015-11-23 12:38:26,792 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 12:38:26 INFO - 2015-11-23 12:38:26,792 DEBUG : BROWSER_OUTPUT: __metrics 12:38:27 INFO - 2015-11-23 12:38:27,969 INFO : Browser initialized. 12:38:27 INFO - 2015-11-23 12:38:27,970 INFO : Running cycle 1/1 for v8_7 test... 12:38:27 INFO - 2015-11-23 12:38:27,970 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpu1My0O/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 12:38:39 INFO - 2015-11-23 12:38:39,979 DEBUG : BROWSER_OUTPUT: RSS: Main: 139603968 12:38:39 INFO - 2015-11-23 12:38:39,979 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,449 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:43424/tests/v8_7/run.html (next: http://localhost:43424/tests/v8_7/run.html) 12:39:01 INFO - 2015-11-23 12:39:01,707 DEBUG : BROWSER_OUTPUT: RSS: Main: 138817536 12:39:01 INFO - 2015-11-23 12:39:01,707 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: __start_tp_report 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |0;Richards;162.39038648911983 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;190.11406844106463 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |2;Encrypt;279.79854504756577 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5081.218274111675 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1067.2358591248667 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |5;Earley;702.2471910112359 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |6;Boyer;12575 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |7;RegExp;25974.358974358973 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |8;Splay;594.0828402366864 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4845.410628019324 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: __end_tp_report 12:39:01 INFO - 2015-11-23 12:39:01,708 DEBUG : BROWSER_OUTPUT: __startTimestamp1448311141700__endTimestamp 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: Number of tests: 10 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:162.39 Median:162.39 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: Values: 162.4 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:190.11 Median:190.11 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: Values: 190.1 12:39:01 INFO - 2015-11-23 12:39:01,709 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,710 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:279.80 Median:279.80 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,710 DEBUG : BROWSER_OUTPUT: Values: 279.8 12:39:01 INFO - 2015-11-23 12:39:01,710 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,710 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5081.22 Median:5081.22 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,710 DEBUG : BROWSER_OUTPUT: Values: 5081.2 12:39:01 INFO - 2015-11-23 12:39:01,711 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,711 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1067.24 Median:1067.24 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,711 DEBUG : BROWSER_OUTPUT: Values: 1067.2 12:39:01 INFO - 2015-11-23 12:39:01,711 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,711 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:702.25 Median:702.25 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: Values: 702.2 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12575.00 Median:12575.00 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: Values: 12575.0 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25974.36 Median:25974.36 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: Values: 25974.4 12:39:01 INFO - 2015-11-23 12:39:01,712 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,713 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:594.08 Median:594.08 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,713 DEBUG : BROWSER_OUTPUT: Values: 594.1 12:39:01 INFO - 2015-11-23 12:39:01,713 DEBUG : BROWSER_OUTPUT: 12:39:01 INFO - 2015-11-23 12:39:01,713 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4845.41 Median:4845.41 stddev:0.00 (0.0%) 12:39:01 INFO - 2015-11-23 12:39:01,713 DEBUG : BROWSER_OUTPUT: Values: 4845.4 12:39:01 INFO - 2015-11-23 12:39:01,713 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 12:39:01 INFO - 2015-11-23 12:39:01,713 DEBUG : BROWSER_OUTPUT: 12:39:02 INFO - 2015-11-23 12:39:02,661 INFO : Browser exited with error code: 0 12:39:02 INFO - 2015-11-23 12:39:02,676 INFO : Completed test v8_7 (00:00:41) 12:39:02 INFO - 2015-11-23 12:39:02,693 INFO : Completed test suite (00:20:21) 12:39:02 INFO - 2015-11-23 12:39:02,693 DEBUG : Working with test: dromaeo_css 12:39:02 INFO - 2015-11-23 12:39:02,693 DEBUG : Generating results file: dromaeo_css 12:39:02 INFO - 2015-11-23 12:39:02,695 DEBUG : Working with test: kraken 12:39:02 INFO - 2015-11-23 12:39:02,695 DEBUG : Generating results file: kraken 12:39:02 INFO - 2015-11-23 12:39:02,695 INFO : javascript benchmark 12:39:02 INFO - 2015-11-23 12:39:02,695 DEBUG : Working with test: v8_7 12:39:02 INFO - 2015-11-23 12:39:02,695 DEBUG : Generating results file: v8_7 12:39:02 INFO - 2015-11-23 12:39:02,696 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 12:39:02 INFO - 2015-11-23 12:39:02,751 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,43]] 12:39:02 INFO - 2015-11-23 12:39:02,751 DEBUG : process_Request line: dromaeo_css 6215.06 graph.html#tests=[[72,132,43]] 12:39:02 INFO - 2015-11-23 12:39:02,751 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 12:39:02 INFO - 2015-11-23 12:39:02,781 DEBUG : process_Request line: kraken 1538.70 graph.html#tests=[[232,132,43]] 12:39:02 INFO - 2015-11-23 12:39:02,781 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 12:39:02 INFO - 2015-11-23 12:39:02,810 DEBUG : process_Request line: v8_7 21402.19 graph.html#tests=[[230,132,43]] 12:39:02 INFO - 2015-11-23 12:39:02,811 INFO : javascript benchmark 12:39:02 INFO - 2015-11-23 12:39:02,815 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2642.6564546608943, 2681.2358477833823, 2717.116936995476, 2725.168823508829, 2746.6841313248974, 4497.79759910804, 4686.812527498904, 4716.268978308359, 4722.409698787652, 4753.762311884409, 4601.79291931863, 4631.536846315366, 4657.184992626286, 4797.2324428091515, 4805.8558243252755, 4265.083007153461, 4361.672874534407, 4399.340098985162, 4402.823887044515, 4442.822287108512, 4385.51759306476, 4387.298032314814, 4426.601605855472, 4455.175792478386, 4542.09158168366, 4179.728317659343, 4302.591253830881, 4445.199864024475, 4453.532379100213, 4504.887377815565, 4272.46594175728, 4386.8903277418, 4389.297712366006, 4405.691601587891, 4423.734575925422, 4338.544452832439, 4365.519792822787, 4369.019138755962, 4400.471943366784, 4415.933760993587, 4383.780810959439, 4530.456345238593, 4590.081983603292, 4626.676132670715, 4635.11932732783, 5118.97440512795, 5156.74216289184, 5158.613104017214, 5162.019216348919, 5172.19830926207, 5156.767945442464, 5161.535461808456, 5168.9741551292, 5174.042802081589, 5226.738663066832, 4522.389477420572, 4627.213373726475, 4686.835960741358, 4778.784954677048, 4796.088743138827, 5238.764255608507, 5248.2390053442805, 5264.236685680631, 5266.47335266478, 5273.868153296122, 5043.84868453947, 5060.620453466005, 5070.3155074064525, 5070.442251352349, 5110.770015349318, 4738.526147385234, 4931.4821943696115, 4947.975260123676, 5064.1897296433135, 5136.409312928986, 4948.4309304429735, 4979.029089327546, 4980.05378977993, 4983.25251212321, 4988.800447982113, 4943.975280123576, 4945.67853089548, 4947.802087916443, 4961.5286547777905, 4986.853023804545, 4065.2276067547073, 4106.691998100155, 4176.373543968369, 4197.517285512145, 4213.115245798416, 3706.092007458136, 3711.2763011212555, 3717.553893532793, 3727.1986522897164, 3739.027852758248, 4409.559044095565, 4434.645228381722, 4447.155040542287, 4467.776611169428, 4483.2602620567895, 4854.077725232195, 4977.104121258209, 4978.103941290602, 4981.626378021663, 5115.7442127893455, 4383.473983121982, 4450.577195166518, 4477.462704475483, 4505.05393867285, 4524.163029839425, 4482.238019536687, 4514.074614703978, 4514.503404625489, 4519.389882365905, 4550.408446901882, 4597.517260687579, 4665.6967297125575, 4716.905661886674, 4777.4267087949665, 4821.927671085006, 5082.085224659597, 5152.922706159336, 5188.040212560688, 5190.922136168036, 5204.34945631796, 4886.765218256846, 4917.409910810726, 4919.335889654851, 4926.4088309403105, 4958.900821983468, 4775.71345719258, 4873.658843880894, 4883.487233840396, 5034.2951986721155, 5100.107481190851, 5028.220625803006, 5032.169692000779, 5056.292119103402, 5067.645264831426, 5107.0, 4850.95149048505, 4861.51384861511, 4866.148424025852, 4869.756512174448, 4910.165271903714, 4743.573078422958, 4772.7136371817805, 4861.833160041494, 4869.6591238612955, 4905.656604037683, 4774.856754297377, 4784.282357646381, 4830.516948305141, 4838.927416088832, 4852.417709874697, 4699.03669747694, 4942.159832828356, 4955.603551715926, 4969.925451118163, 5007.899842003067, 4664.090502352009, 4733.763311834326, 4770.713757174581, 4821.566059054561, 4823.348847905488], "unit": "ms", "name": "dojo.html", "value": 4639.336154202224}, {"lowerIsBetter": false, "replicates": [536.179645142931, 560.1345920552745, 572.5963195946858, 577.9856352102063, 581.9738111784969, 37386.25227495449, 37757.0, 37945.24109517808, 38157.42763858545, 38184.0, 40798.388024179585, 40923.0, 41186.64573605434, 41355.793221033855, 41441.0, 8009.519428834274, 8129.5528745918955, 8130.674773009073, 8140.552269625168, 8145.226203510657, 7782.18287079857, 7914.6438410271385, 7916.604169791516, 7927.4847134936335, 7964.123946365895, 7907.6046197690175, 8004.399670024743, 8004.51972881629, 8015.959920200391, 8049.154838741935, 7937.245961633665, 7987.08148562914, 8018.118007019223, 8031.638576264082, 8049.275565199102, 7811.4922530035365, 7984.321332686729, 7986.361091112697, 8027.678892844279, 8047.597620119029, 37907.431388528916, 38466.42300365497, 38495.61504384948, 38527.0, 38628.61371386278, 2960.84238888175, 3036.802607830484, 3076.646185688652, 3089.7373723233554, 3405.4210784166753, 28034.71965280362, 28317.57523637147, 28476.857615711997, 28661.0, 29029.709702903125, 3401.3367393358058, 3407.5740532433447, 3407.931841363159, 3510.3330367230146, 3579.6599323064265, 229700.0, 230382.0, 230662.0, 230846.0, 231553.9999999983, 46706.06587868224, 47193.76403117963, 55974.72012639911, 57470.42529574651, 57630.0, 57800.71099644475, 57840.42159578435, 58064.0, 58405.70797145987, 58406.12390814141, 12408.937955310166, 12516.561920332744, 12529.498820047096, 12564.308963007123, 12588.30764307972, 9192.264618830477, 9231.630734770533, 9288.210502107397, 9323.72028839136, 9379.765505862408, 19081.904590477236, 19185.0, 19222.903885480482, 19314.517137071405, 19319.22723091089, 7588.354989825927, 7843.294103530709, 7871.763847084597, 7904.841903161904, 7905.288524032865, 785.1912530094012, 842.2588122452203, 934.243262957007, 963.450833025183, 1008.495752123938, 25768.355791105372, 26285.737142628328, 26756.464870702475, 26822.5976610351, 26901.461970760476, 910.0717268386209, 914.8719179314901, 921.3090182363228, 930.7533503621546, 943.5942544705842, 12818.61544153677, 12845.421956012002, 12853.614391568268, 14050.0, 14818.0, 271852.0, 275192.0, 277972.0, 278446.0, 279808.0, 47088.52911470841, 47454.76272618615, 47483.0, 47532.0, 47662.28506572404, 1129.3224065560762, 1137.8008848451489, 1144.5936692474218, 1145.3128123126057, 1176.1590462819127, 25351.61972570376, 26576.468470630094, 26763.19710408691, 26981.190564283104, 27134.864325678245, 39304.60695393124, 39648.2070358597, 39727.40408893926, 39773.60226397699, 39784.801075995594, 171947.14026429786, 173672.0, 173784.0, 174112.0, 174220.0, 28473.430531388844, 28951.131466056053, 29067.0, 29363.55954660639, 29392.41215175727, 34853.65146348504, 35010.82494587511, 35410.29179416346, 35473.29053418969, 35639.28721425609, 29972.250693732833, 30342.0, 30597.388052239276, 31131.377372452876, 31405.371892562478, 30489.847550762104, 30666.540001900437, 30704.385912282076, 30794.538081928342, 32166.83916580402, 30662.233444164074, 30834.229144271572, 30943.381132377675, 31155.0, 31270.0, 25673.871630641726, 27124.593131102654, 27597.448051038464, 28032.43935121327, 28275.434491309647, 23408.6488702673, 23476.178333758235, 23595.882020589786, 23791.405214869766, 23899.641505377087], "unit": "ms", "name": "ext.html", "value": 16504.008596560216}, {"lowerIsBetter": false, "replicates": [343.19691920905075, 343.5516650770743, 343.5585272924292, 345.4748781851584, 347.156409923885, 12598.559050433236, 12992.155509891874, 15111.697766044672, 15294.770578441332, 16998.150092495358, 12759.298238596897, 13604.591862244124, 13807.171569705799, 14954.850451495482, 15106.244687765622, 4921.70469771814, 5036.320096786942, 5056.6713163644245, 5057.468965758598, 5065.240213967897, 5080.1617733074, 5083.491650834905, 5083.898322033557, 5088.5929125670045, 5280.102382594949, 5189.325387699594, 5227.660202086871, 5233.764480598363, 5269.446708095633, 5282.286891269668, 5876.882462350751, 5881.206037184989, 5884.235049443545, 5885.970570147165, 5895.233619629442, 5101.7194054327, 5120.283160357553, 5147.253648220987, 5154.226865970097, 5190.92213616796, 11687.707807304885, 11872.703182420422, 11875.109366797526, 11951.402429878472, 14269.78595321071, 1759.4018033868417, 1762.6562820250056, 1794.605186858889, 1807.764990551233, 1896.5543097372106, 8585.527795971218, 8936.41913275635, 9070.138336857988, 9130.863037054449, 9341.205997490222, 1729.0, 1784.0722824131378, 1790.6239689665185, 1790.8209179082119, 1829.1768704083083, 54819.725901370635, 55047.449525505035, 55064.0, 56393.71803140999, 56624.43375566274, 9600.375975561567, 9781.0, 9791.853122203172, 9828.361156524803, 9907.356021858555, 12472.937635311766, 12482.188657737219, 12490.625281241577, 12505.124641275024, 12531.0, 6374.139491168726, 6436.098946147543, 6609.20689517261, 6685.966570167118, 6775.390214880685, 6279.937200627935, 6315.936840631627, 6319.462845658079, 6328.11406403104, 6367.235931688135, 4174.436451079066, 4235.4917409911, 4294.957050429456, 4302.870913872589, 4310.224159651293, 1686.544632949097, 1729.7405389191722, 1738.9304427822744, 1750.88619239749, 1763.453329467869, 796.9036867960151, 820.7332616899531, 881.9592880401188, 902.1835239108617, 999.3703966501204, 15478.5356439307, 15580.688386232212, 15646.374145034299, 15825.366985320457, 16039.0, 808.7897146741772, 835.849547081519, 838.4340570115148, 843.9915600843913, 855.9529225892511, 9068.093190680878, 9079.228265597498, 9143.908560914439, 9162.541872906328, 9341.626334946663, 488414.0, 492480.0, 495275.1889924435, 495616.0, 503310.0, 67389.32610673929, 68635.0, 68827.65586172037, 69566.0, 69967.30032699608, 1042.7601651620018, 1052.7947050325113, 1054.2725519391595, 1057.4818339013827, 1073.9624113156, 13341.0, 14087.929560352133, 14114.0, 14267.571972840831, 14269.357878895682, 28137.296567585974, 28544.57183142213, 28645.99739009125, 29089.418211635224, 32817.67182328146, 39011.0, 39540.80229598834, 39569.60430395774, 41465.58534414617, 42855.78572107244, 8469.703560375357, 8661.740147795575, 9129.45223286605, 9135.40619859707, 9143.13140251675, 9404.482753448627, 9670.129688328085, 9856.901430985597, 10328.483575821028, 10500.422476763852, 9135.360524763202, 9367.297452691211, 9468.14786669203, 9688.660896868576, 9699.369540979813, 8623.913760862311, 8991.955040224757, 9007.954960225157, 9171.495567743572, 9638.036196380306, 8990.370674052754, 8994.550272486218, 9400.482973436527, 9917.702468925943, 9971.252156088467, 13875.791863122264, 13902.930485347508, 14429.20639364845, 14504.492342767953, 14584.781228281372, 14541.345639446461, 14681.045732027384, 14821.703565928405, 15064.096154230781, 15327.770083448535], "unit": "ms", "name": "jquery.html", "value": 7906.036443545821}, {"lowerIsBetter": false, "replicates": [1484.2207840883527, 1616.11921502781, 1643.6768401436846, 1668.449411694141, 1689.4593730006395, 6152.723127459264, 6304.117423560705, 6433.5818171818855, 6685.331466853312, 6698.966505167474, 6458.580192287498, 6536.836579085525, 6569.40875321221, 6575.14523111996, 6598.505112116586, 2008.02610733794, 2042.9897850510802, 2052.9589408211828, 2054.3734161080865, 2055.0341339570455, 2051.1282704850455, 2067.576146889884, 2071.420002399323, 2082.125507286943, 2096.9895150524226, 2025.4531276555322, 2028.563858770364, 2031.989840050805, 2050.169681279084, 2059.258666879922, 2047.7030830529563, 2078.4388215181966, 2080.906359213839, 2082.250389859649, 2088.603165398569, 2034.5727397246596, 2038.5413282011577, 2058.9794102058936, 2059.104289633999, 2077.5637116205617, 6563.967180164069, 6573.1783527059115, 6587.571807832475, 6608.339166083401, 6624.86750264992, 4008.2785098682225, 4060.167665628539, 4078.12320351123, 4093.1813637272367, 4111.075008123178, 2684.4362683836416, 2707.2690373599016, 2708.783297336228, 2780.8470534120615, 2822.6048353230562, 842.8482873082843, 857.3869683176558, 858.3433673239977, 862.6420035685184, 889.4485419040236, 8042.879356809653, 8051.154628764012, 8054.476459030145, 8112.31045361145, 8132.837343253161, 3511.122219445139, 3529.6646818552194, 3560.3769340365334, 3561.3233485637647, 3566.1262990567475, 6808.285130061371, 6810.31896810315, 6822.147231596051, 6833.726650934006, 6833.931660683429, 3824.101336185994, 3835.4055121456217, 3838.1556057667267, 3854.8265328060306, 3876.592957739453, 3089.3666798306294, 3121.8439078046463, 3415.7608967372544, 3490.3019396120876, 3502.124468882779, 3025.6217972753407, 3070.401271752032, 3076.553899684533, 3079.3687294104657, 3106.39425312062, 941.1341565759518, 950.2113246005798, 953.137410643355, 957.2820384711466, 960.9471479068578, 1094.1465656787718, 1115.2694984784978, 1135.40391294571, 1148.9712757181137, 1158.6176561734608, 6195.938040619626, 6220.7511699531515, 6252.5935814171935, 6255.718492667841, 6260.812175634738, 1017.3539802225492, 1095.0801326885296, 1096.3257596578046, 1126.9380184089953, 1128.5260190719916, 4855.830045948375, 4879.780409881564, 4890.217565189552, 4913.385826771653, 4937.23472861707, 7323.2676732326345, 7446.739364122338, 7447.031885854804, 7579.355754760797, 7720.45956783031, 7390.852182956311, 7400.555966642019, 7414.6292685365515, 7434.888476672854, 7435.962820185864, 6139.324674285825, 6252.5935814171935, 6259.2488901332135, 6279.560430769893, 6287.402696743802, 6201.3178550358525, 6201.565890387629, 6207.7584483102655, 6235.033569796688, 6255.812325630239, 6796.116504854535, 6931.965340173469, 6940.27127151662, 7133.785986420416, 7155.177154627285, 7077.5399599025895, 7180.31786980236, 7184.568925864465, 7281.927180728125, 7298.416126709744, 5206.401263854706, 5296.655717378358, 5824.15549745293, 5902.2622172228475, 5906.763729450946, 5795.594308398372, 6116.847078823065, 6139.96930015365, 6149.938500614937, 6164.537659675632, 5664.0937450007805, 5785.0, 5800.24596802413, 5813.069908814569, 6017.127516509994, 5721.113227449752, 5723.942760572508, 5820.534357251495, 5866.5893387462465, 5891.086881533369, 5685.602007859576, 5687.886242275049, 5692.544596432358, 5738.368779434342, 5942.227510423617, 5354.9464505354445, 5386.461353864739, 5408.161734931092, 5423.511883930465, 5426.0, 5490.752916118864, 5555.472230138131, 5565.888682226252, 5566.415526369673, 5571.637843540157], "unit": "ms", "name": "mootools.html", "value": 3826.419157404605}, {"lowerIsBetter": false, "replicates": [309.66401454421947, 313.3357282560971, 315.17581524313925, 317.2275509135256, 319.09854660583846, 5517.806876759314, 5640.605157638967, 5676.744546495407, 5683.744231509587, 5787.47912687858, 5547.8890422191635, 5601.075822489284, 5638.295213098363, 5649.971750141243, 5654.293213348332, 4302.806373713191, 4320.94136936451, 4323.870283891489, 4329.5021072576665, 4342.565743425664, 4335.111302183061, 4343.739375637456, 4349.717268377562, 4349.7390156590545, 4354.477462704464, 4057.9797101014456, 4145.31602285624, 4195.0, 4309.2889673204045, 4313.094250207445, 4158.2307273154565, 4184.3305071188615, 4185.895352616179, 4186.539480657125, 4189.183109293689, 3550.236699109678, 3555.2711694102645, 3563.6436356364156, 3566.0549954261883, 3576.2847430513743, 5356.946430535684, 5372.301600791872, 5383.16560933056, 5391.167003218924, 5395.730213489349, 4776.737279449629, 4786.928196077061, 4790.161721698689, 4792.041591681677, 4985.451600323961, 5736.627119237278, 5841.766329346821, 5853.385394533555, 5883.61756485827, 5926.733297001645, 4047.1298670785923, 4079.2453396121514, 4080.489938757655, 4081.1837632473625, 4081.3061779497557, 6141.815745527641, 6211.19254496917, 6213.316535181127, 6216.129741836146, 6223.533235007438, 4132.380142978577, 4208.158368326347, 4214.3889136075095, 4217.156568686214, 4217.894552636209, 4280.101178752497, 4280.379344995021, 4281.614654681093, 4282.935755963663, 4284.10033892886, 4892.241702536113, 4919.77860996256, 4921.0, 4929.507049295042, 4930.8767280818265, 5872.265966754156, 5901.3508514063415, 5902.675352855634, 5909.261342332208, 5915.40845915405, 1476.217604669527, 1511.4483213626947, 1517.2186324043128, 1521.0949485056374, 1527.1676936069869, 935.8081593273499, 1006.2503434941016, 1012.7670635753818, 1024.702836177515, 1026.3072426112344, 5056.544910958031, 5057.367829021372, 5059.822906198266, 5084.389873215164, 5090.389153301628, 5998.550108741774, 6019.067044608093, 6038.365971572922, 6038.547108966845, 6045.093236014633, 5046.545810877039, 5074.771635276422, 5076.060928728197, 5082.313887625197, 5085.949140508622, 3230.2247460609283, 3289.588801399825, 3312.0, 3312.370649576621, 3327.9833600832326, 5716.857078573069, 5729.226554415184, 5729.3984131665575, 5745.3105627324985, 5755.021646320136, 6285.308616052231, 6313.337099604475, 6313.463355614732, 6315.305316415191, 6319.210098737658, 5676.68778217202, 5694.914576281359, 5764.250647415809, 5783.3638299787835, 5852.531797456279, 6188.721507532262, 6208.379162083756, 6217.502599792097, 6227.470664993526, 6247.0629405589525, 6057.061155520902, 6072.574919755752, 6073.696315184311, 6074.149619053424, 6076.969615152073, 5610.691411972381, 5808.5062769665055, 5840.766369345179, 5847.590668653153, 5884.58807883444, 4160.147169830238, 4208.452901122834, 4214.283571792741, 4223.852165174204, 4225.640820530167, 6221.5333849962335, 6225.128482012612, 6239.064140378798, 6244.313125556276, 6248.0940263660605, 5948.345681975065, 5972.0, 5980.192673988956, 5998.400159984141, 6007.669578173068, 5783.537317014545, 5940.732667030081, 5954.940450595439, 5965.8806823862415, 5967.850803729942, 5797.072468405035, 5832.94167058324, 5841.678707670949, 5842.152887831156, 5863.648181109147, 5976.731047102804, 5985.461308482258, 6019.6990150493175, 6024.036154215304, 6026.7589296429405, 5667.291588551431, 5831.271091113611, 5831.562632802642, 5849.151872978479, 5865.442782935615], "unit": "ms", "name": "prototype.html", "value": 4409.370596340898}, {"lowerIsBetter": false, "replicates": [672.4250765595416, 711.654847399011, 717.8205448637841, 767.1024900865987, 781.2460975158972, 11477.942610286947, 11692.473838677259, 11795.292282463059, 11856.170068095225, 11910.880891191086, 12033.51865925362, 12165.270083794956, 13687.93156034221, 13845.515406960758, 13939.790903136462, 783.0837919634042, 790.3677058353323, 804.3283857978565, 806.3226889412892, 810.1655295046082, 798.4490701416033, 800.6197056398222, 803.9276465118138, 805.3758337288618, 805.5488926201317, 823.4565186976597, 829.2578142562403, 829.6100832608664, 829.6888666749969, 831.1024093978489, 821.8315245374683, 822.153182222312, 824.0482243009334, 824.085265355455, 826.8222332198546, 608.248812716295, 609.0529227051933, 612.3967891626744, 612.6140531465148, 612.6354818882758, 11646.126540509496, 11655.59205427806, 11748.823767643493, 11764.352960587164, 11810.173287869853, 10817.945910270477, 10998.505067271992, 11034.944825275903, 11227.0, 11461.713457163554, 9004.459732416077, 9585.0, 9596.856047159297, 9656.903430965742, 9926.404415735078, 3230.8384580771103, 3246.610406751205, 3255.9023229303157, 3296.3901678189372, 3331.1505566080737, 41379.75860724153, 41603.0, 41766.1646767066, 41908.79045604783, 42070.579294206975, 9189.632414703337, 9227.723168304961, 9250.121238482334, 9276.397034192756, 9318.254539636948, 16508.504744857673, 16534.66930661404, 16536.0, 16547.669046619, 16555.08947007902, 5753.884922301614, 5845.503132233723, 6102.664353460514, 6175.69121543921, 6178.165947597017, 3513.8243087845503, 3559.2169722660974, 3575.1955809942556, 3579.2483578448296, 3599.6400359963795, 2705.9594106088425, 2744.31392151962, 2776.2642899631614, 2777.388974425623, 2780.3744157564793, 491.5821551681114, 493.62484511770595, 497.4900726755105, 497.9950200498021, 504.2360823352624, 451.6432018705186, 460.94007778989186, 478.09401184754694, 541.4676465602336, 595.9910601340983, 7360.190379058299, 7807.258310460497, 8039.437239393304, 8191.918080819235, 8291.170882911661, 470.6117453101205, 477.1697246790629, 548.506344290142, 554.1742803223249, 617.7930393318198, 3595.1371670799344, 3741.345264578688, 3792.27946690128, 3819.4652748614662, 3870.9806450967567, 51800.0, 51818.48181518212, 52155.47844521582, 52318.738406307726, 52380.73809631004, 45830.0, 46412.0, 46447.0, 46585.30122048172, 46609.5339046612, 41373.0, 42448.78775606102, 42802.999999999374, 43165.78417107894, 43277.783611081744, 7414.962925185555, 7611.0, 7653.617319134132, 7713.498622589514, 7788.221177882393, 29675.10974670677, 29682.257943551584, 29746.85126574353, 29807.701922980494, 30235.09294721162, 37019.0, 37933.620663794114, 41417.58582414137, 42020.579794201665, 42173.367399488416, 8571.914280857362, 9167.08329167078, 9227.21568666644, 9281.211097056826, 9416.81166376655, 10309.913148838865, 10401.21990850674, 10452.111570516592, 10500.78998420012, 10581.153507719519, 9901.257405694458, 9912.0, 10249.077583017564, 10308.793824123626, 10394.688159355232, 9028.774280643036, 9106.590203440994, 9329.860052099088, 9394.342396032485, 9400.905990940004, 9403.905960940303, 9420.152186303265, 9708.6116555337, 9752.317337786288, 9927.056929591678, 8282.751517454486, 8469.66121355139, 8478.23695867375, 8483.194096560817, 8537.701180458655, 8135.79660508492, 8399.496030238206, 8846.823063538823, 9150.0, 9267.258619310303], "unit": "ms", "name": "yui.html", "value": 5642.288524998361}], "name": "dromaeo_css", "value": 6215.062663905284}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [112.0, 106.0, 112.0, 112.0, 112.0, 126.0, 114.0, 112.0, 113.0, 115.0], "unit": "ms", "name": "ai-astar", "value": 113.4}, {"lowerIsBetter": true, "replicates": [161.0, 131.0, 152.0, 169.0, 146.0, 167.0, 155.0, 140.0, 174.0, 133.0], "unit": "ms", "name": "audio-beat-detection", "value": 152.8}, {"lowerIsBetter": true, "replicates": [163.0, 164.0, 163.0, 166.0, 162.0, 164.0, 174.0, 160.0, 164.0, 163.0], "unit": "ms", "name": "audio-dft", "value": 164.3}, {"lowerIsBetter": true, "replicates": [74.0, 74.0, 73.0, 72.0, 74.0, 75.0, 128.0, 73.0, 73.0, 74.0], "unit": "ms", "name": "audio-fft", "value": 79.0}, {"lowerIsBetter": true, "replicates": [93.0, 92.0, 124.0, 90.0, 91.0, 92.0, 124.0, 92.0, 93.0, 131.0], "unit": "ms", "name": "audio-oscillator", "value": 102.2}, {"lowerIsBetter": true, "replicates": [110.0, 111.0, 110.0, 113.0, 110.0, 109.0, 110.0, 110.0, 110.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 110.2}, {"lowerIsBetter": true, "replicates": [147.0, 146.0, 147.0, 147.0, 147.0, 149.0, 147.0, 148.0, 150.0, 147.0], "unit": "ms", "name": "imaging-darkroom", "value": 147.5}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 97.0, 97.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0], "unit": "ms", "name": "imaging-desaturate", "value": 96.3}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 73.0, 72.0, 73.0, 72.0, 73.0, 73.0, 73.0, 73.0], "unit": "ms", "name": "json-parse-financial", "value": 72.6}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 69.0, 69.0, 69.0, 69.0, 68.0, 69.0, 68.0, 70.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 68.8}, {"lowerIsBetter": true, "replicates": [91.0, 83.0, 83.0, 86.0, 84.0, 91.0, 87.0, 86.0, 83.0, 82.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 85.6}, {"lowerIsBetter": true, "replicates": [121.0, 126.0, 133.0, 133.0, 129.0, 123.0, 131.0, 124.0, 127.0, 132.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 127.9}, {"lowerIsBetter": true, "replicates": [142.0, 138.0, 161.0, 147.0, 151.0, 134.0, 166.0, 150.0, 147.0, 150.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 148.6}, {"lowerIsBetter": true, "replicates": [69.0, 70.0, 70.0, 71.0, 70.0, 69.0, 69.0, 69.0, 69.0, 69.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 69.5}], "name": "kraken", "value": 1538.6999999999998}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [162.39038648911983], "unit": "score", "name": "Richards", "value": 217.38971600000008}, {"lowerIsBetter": false, "replicates": [190.11406844106463], "unit": "score", "name": "DeltaBlue", "value": 347.7806799999999}, {"lowerIsBetter": false, "replicates": [279.79854504756577], "unit": "score", "name": "Encrypt", "value": 951.330894}, {"lowerIsBetter": false, "replicates": [5081.218274111675], "unit": "score", "name": "Decrypt", "value": 52.38527172827171}, {"lowerIsBetter": false, "replicates": [1067.2358591248667], "unit": "score", "name": "RayTrace", "value": 693.3696929999998}, {"lowerIsBetter": false, "replicates": [702.2471910112359], "unit": "score", "name": "Earley", "value": 949.0433120000004}, {"lowerIsBetter": false, "replicates": [12575.0], "unit": "score", "name": "Boyer", "value": 52.99904572564615}, {"lowerIsBetter": false, "replicates": [25974.358974358973], "unit": "score", "name": "RegExp", "value": 35.072472852912156}, {"lowerIsBetter": false, "replicates": [594.0828402366864], "unit": "score", "name": "Splay", "value": 137.17110557768927}, {"lowerIsBetter": false, "replicates": [4845.410628019324], "unit": "score", "name": "NavierStokes", "value": 306.26919242273203}], "name": "v8_7", "value": 21402.18701618642}]} 12:39:02 INFO - RETURN: dromaeo_css: 6215.06 12:39:02 INFO - RETURN: kraken: 1538.70 12:39:02 INFO - RETURN: v8_7: 21402.19 12:39:02 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,43]]", "result": "21402.19"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,43]]", "result": "1538.70"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,43]]", "result": "6215.06"}}} 12:39:02 INFO - Return code: 0 12:39:02 INFO - # TBPL SUCCESS # 12:39:02 INFO - Running post-action listener: _resource_record_post_action 12:39:02 INFO - Running post-run listener: _resource_record_post_run 12:39:03 INFO - Total resource usage - Wall time: 1235s; CPU: 13.0%; Read bytes: 4096; Write bytes: 514715648; Read time: 396; Write time: 783664 12:39:03 INFO - install - Wall time: 14s; CPU: 14.0%; Read bytes: 0; Write bytes: 149573632; Read time: 0; Write time: 148556 12:39:03 INFO - run-tests - Wall time: 1222s; CPU: 13.0%; Read bytes: 4096; Write bytes: 311590912; Read time: 396; Write time: 555056 12:39:03 INFO - Running post-run listener: _upload_blobber_files 12:39:03 INFO - Blob upload gear active. 12:39:03 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 12:39:03 INFO - Copying logs to upload dir... 12:39:03 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1264.524726 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 4 secs) (at 2015-11-23 12:39:03.974289) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-23 12:39:03.977416) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009874 build_url: 'https://queue.taskcluster.net/v1/task/d8NPS8_UQdC0BwIB3Ad9cA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-23 12:39:04.030232) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:39:04.030769) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=9c54e757a4c805d85fea3bc7000001f2-1448309878.3176-838950311 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004603 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-23 12:39:04.080738) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-23 12:39:04.084327) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-23 12:39:04.084704) ========= ========= Total master_lag: 0.22 =========